# Checking port 54224 # Found port 54224 Name: publisher Data directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/pgdata Backup directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/backup Archive directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/archives Connection string: port=54224 host=/tmp/yPRe1CFHB5 Log file: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/log/040_standby_failover_slots_sync_publisher.log [22:51:39.107](0.014s) # initializing database system by copying initdb template # Running: cp -RPp /tmp/cirrus-ci-build/build/tmp_install/initdb-template /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/pgdata # Running: /tmp/cirrus-ci-build/build/src/test/regress/pg_regress --config-auth /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/pgdata --create-role repl_role ### Starting node "publisher" # Running: pg_ctl -w -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/pgdata -l /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/log/040_standby_failover_slots_sync_publisher.log -o --cluster-name=publisher start waiting for server to start.... done server started # Postmaster PID for node "publisher" is 15004 # Checking port 54225 # Found port 54225 Name: subscriber1 Data directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_subscriber1_data/pgdata Backup directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_subscriber1_data/backup Archive directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_subscriber1_data/archives Connection string: port=54225 host=/tmp/yPRe1CFHB5 Log file: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/log/040_standby_failover_slots_sync_subscriber1.log [22:51:39.282](0.174s) # initializing database system by copying initdb template # Running: cp -RPp /tmp/cirrus-ci-build/build/tmp_install/initdb-template /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_subscriber1_data/pgdata # Running: /tmp/cirrus-ci-build/build/src/test/regress/pg_regress --config-auth /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_subscriber1_data/pgdata ### Starting node "subscriber1" # Running: pg_ctl -w -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_subscriber1_data/pgdata -l /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/log/040_standby_failover_slots_sync_subscriber1.log -o --cluster-name=subscriber1 start waiting for server to start.... done server started # Postmaster PID for node "subscriber1" is 15039 #### Begin standard error psql::1: WARNING: outfuncs/readfuncs failed to produce an equal rewritten parse tree #### End standard error #### Begin standard error psql::1: WARNING: outfuncs/readfuncs failed to produce an equal rewritten parse tree #### End standard error [22:51:39.476](0.194s) ok 1 - logical slot has failover false on the publisher #### Begin standard error psql::1: WARNING: outfuncs/readfuncs failed to produce an equal rewritten parse tree #### End standard error [22:51:39.516](0.040s) ok 2 - logical slot has failover true on the publisher #### Begin standard error psql::1: WARNING: outfuncs/readfuncs failed to produce an equal rewritten parse tree #### End standard error [22:51:39.541](0.026s) ok 3 - logical slot has failover false on the publisher #### Begin standard error psql::1: WARNING: outfuncs/readfuncs failed to produce an equal rewritten parse tree #### End standard error [22:51:39.569](0.027s) ok 4 - logical slot has failover true on the publisher [22:51:39.595](0.026s) ok 5 - altering failover is not allowed for enabled subscription [22:51:39.605](0.009s) ok 6 - cannot sync slots on a non-standby server # Taking pg_basebackup backup from node "publisher" # Running: pg_basebackup -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/backup/backup -h /tmp/yPRe1CFHB5 -p 54224 --checkpoint fast --no-sync # Backup finished # Checking port 54226 # Found port 54226 Name: standby1 Data directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_standby1_data/pgdata Backup directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_standby1_data/backup Archive directory: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_standby1_data/archives Connection string: port=54226 host=/tmp/yPRe1CFHB5 Log file: /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/log/040_standby_failover_slots_sync_standby1.log # Initializing node "standby1" from backup "backup" of node "publisher" ### Enabling streaming replication for node "standby1" ### Enabling WAL restore for node "standby1" ### Reloading node "publisher" # Running: pg_ctl -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/pgdata reload server signaled (lsub2_slot,0/3000060) (sb1_slot,) ### Starting node "standby1" # Running: pg_ctl -w -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_standby1_data/pgdata -l /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/log/040_standby_failover_slots_sync_standby1.log -o --cluster-name=standby1 start waiting for server to start.... done server started # Postmaster PID for node "standby1" is 15164 Waiting for replication conn regress_mysub1's replay_lsn to pass 0/3000060 on publisher [22:55:15.179](215.575s) # poll_query_until timed out executing this query: # SELECT '0/3000060' <= replay_lsn AND state = 'streaming' # FROM pg_catalog.pg_stat_replication # WHERE application_name IN ('regress_mysub1', 'walreceiver') # expecting this output: # t # last actual query output: # t # with stderr: # WARNING: outfuncs/readfuncs failed to produce an equal rewritten parse tree timed out waiting for catchup at /tmp/cirrus-ci-build/src/test/recovery/t/040_standby_failover_slots_sync.pl line 165. # Postmaster PID for node "publisher" is 15004 ### Stopping node "publisher" using mode immediate # Running: pg_ctl -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_publisher_data/pgdata -m immediate stop waiting for server to shut down.... done server stopped # No postmaster PID for node "publisher" # Postmaster PID for node "subscriber1" is 15039 ### Stopping node "subscriber1" using mode immediate # Running: pg_ctl -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_subscriber1_data/pgdata -m immediate stop waiting for server to shut down.... done server stopped # No postmaster PID for node "subscriber1" # Postmaster PID for node "standby1" is 15164 ### Stopping node "standby1" using mode immediate # Running: pg_ctl -D /tmp/cirrus-ci-build/build/testrun/recovery/040_standby_failover_slots_sync/data/t_040_standby_failover_slots_sync_standby1_data/pgdata -m immediate stop waiting for server to shut down.... done server stopped # No postmaster PID for node "standby1" [22:55:15.517](0.338s) # Tests were run but no plan was declared and done_testing() was not seen. [22:55:15.518](0.000s) # Looks like your test exited with 29 just after 6.