server_start_20240209T115112.963.log
application/octet-stream
Filename: server_start_20240209T115112.963.log
Type: application/octet-stream
Part: 2
Message:
RE: speed up a logical replica setup
2024-02-09 11:52:13.242 UTC [3909] LOG: starting PostgreSQL 17devel on x86_64-pc-linux-gnu, compiled by gcc (GCC) 8.3.1 20190311 (Red Hat 8.3.1-3), 64-bit 2024-02-09 11:52:13.243 UTC [3909] LOG: listening on IPv6 address "::1", port 5432 2024-02-09 11:52:13.243 UTC [3909] LOG: listening on IPv4 address "127.0.0.1", port 5432 2024-02-09 11:52:13.246 UTC [3909] LOG: listening on Unix socket "/tmp/.s.PGSQL.5432" 2024-02-09 11:52:13.252 UTC [3912] LOG: database system was shut down in recovery at 2024-02-09 11:51:53 UTC 2024-02-09 11:52:13.252 UTC [3912] LOG: entering standby mode 2024-02-09 11:52:13.256 UTC [3912] LOG: redo starts at 0/2000028 2024-02-09 11:52:13.257 UTC [3912] LOG: consistent recovery state reached at 0/3001800 2024-02-09 11:52:13.257 UTC [3912] LOG: invalid record length at 0/3001800: expected at least 24, got 0 2024-02-09 11:52:13.257 UTC [3909] LOG: database system is ready to accept read-only connections 2024-02-09 11:52:13.264 UTC [3913] LOG: started streaming WAL from primary at 0/3000000 on timeline 1 2024-02-09 11:52:28.513 UTC [3912] LOG: recovery stopping after WAL location (LSN) "0/30033C8" 2024-02-09 11:52:28.513 UTC [3912] LOG: redo done at 0/30033C8 system usage: CPU: user: 0.00 s, system: 0.00 s, elapsed: 15.25 s 2024-02-09 11:52:28.513 UTC [3912] LOG: last completed transaction was at log time 2024-02-09 11:51:42.822078+00 2024-02-09 11:52:28.513 UTC [3913] FATAL: terminating walreceiver process due to administrator command 2024-02-09 11:52:28.516 UTC [3912] LOG: selected new timeline ID: 2 2024-02-09 11:52:28.562 UTC [3912] LOG: archive recovery complete 2024-02-09 11:52:28.564 UTC [3910] LOG: checkpoint starting: end-of-recovery immediate wait 2024-02-09 11:52:28.578 UTC [3910] LOG: checkpoint complete: wrote 28 buffers (0.2%); 0 WAL file(s) added, 0 removed, 1 recycled; write=0.003 s, sync=0.005 s, total=0.015 s; sync files=19, longest=0.002 s, average=0.001 s; distance=16403 kB, estimate=16403 kB; lsn=0/3004F20, redo lsn=0/3004F20 2024-02-09 11:52:28.581 UTC [3909] LOG: database system is ready to accept connections 2024-02-09 11:52:29.410 UTC [3923] LOG: logical replication apply worker for subscription "pg_createsubscriber_5_3884" has started 2024-02-09 11:52:29.417 UTC [3922] ERROR: subscription "pg_createsubscriber_16389_3884" already exists 2024-02-09 11:52:29.417 UTC [3922] STATEMENT: CREATE SUBSCRIPTION pg_createsubscriber_16389_3884 CONNECTION 'user=postgres port=5431 dbname=testdb' PUBLICATION pg_createsubscriber_16389 WITH (create_slot = false, copy_data = false, enabled = false) 2024-02-09 11:52:29.426 UTC [3923] FATAL: terminating logical replication worker due to administrator command 2024-02-09 11:52:29.427 UTC [3909] LOG: background worker "logical replication apply worker" (PID 3923) exited with exit code 1 2024-02-09 11:52:29.445 UTC [3925] ERROR: publication "pg_createsubscriber_5" does not exist 2024-02-09 11:52:29.445 UTC [3925] STATEMENT: DROP PUBLICATION pg_createsubscriber_5