{"msg":"Opened existing region file \"/var/tmp/test_up/8820/region.json\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.260883407Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Database read version 1","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.261179645Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Database write version 1","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.261198082Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"UUID: 12345678-0000-0000-0000-000000008820","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.26149779Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Blocks per extent:10 Total Extents: 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.261514297Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Crucible Version: Crucible Version: 0.0.1\nCommit SHA: d5ba9129c85ea0d4e5bfb64a325148153466e54b\nCommit timestamp: 2024-03-01T16:08:17.000000000Z  branch: alan/downstairs-builder\nrustc: 1.76.0 stable x86_64-unknown-illumos\nCargo: x86_64-unknown-illumos  Debug: true Opt level: 0","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.261776041Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Upstairs <-> Downstairs Message Version: 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.261819014Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Repair listens on 0.0.0.0:12820 for path:\"/var/tmp/test_up/8820\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.2635651Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"repair"}
{"msg":"listening","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.264162925Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"local_addr":"0.0.0.0:12820","task":"repair"}
{"msg":"Using repair address: 0.0.0.0:12820","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.264331346Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"No SSL acceptor configured","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.264362281Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"downstairs listening on 0.0.0.0:8820","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:20.264471171Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"accepted connection from 127.0.0.1:49842","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:25.349111615Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 6d0b54d4-1565-4235-b7e4-6283272ca0ad with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:25.350245157Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 6d0b54d4-1565-4235-b7e4-6283272ca0ad, session_id: 48046f69-6113-4ca9-8aab-489f64347e80, gen: 1 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:25.350278982Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 6d0b54d4-1565-4235-b7e4-6283272ca0ad, session_id: 48046f69-6113-4ca9-8aab-489f64347e80, gen: 1 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:25.351682297Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [0, 0, 0, 0, 0]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:25.353134344Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:25.353161099Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 6d0b54d4-1565-4235-b7e4-6283272ca0ad, session_id: 48046f69-6113-4ca9-8aab-489f64347e80, gen: 1 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:26:29.368066304Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 6d0b54d4-1565-4235-b7e4-6283272ca0ad, session_id: 48046f69-6113-4ca9-8aab-489f64347e80, gen: 1 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:26:29.368137412Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:49842): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:29.368238785Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:43771","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:34.39320504Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 87908a59-a3f0-4ffe-b816-8c3b517a52d6 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:34.393636505Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 87908a59-a3f0-4ffe-b816-8c3b517a52d6, session_id: a8c3a5c1-fdb5-482e-92c7-cb01f8f3b190, gen: 3 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:34.393673898Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 87908a59-a3f0-4ffe-b816-8c3b517a52d6, session_id: a8c3a5c1-fdb5-482e-92c7-cb01f8f3b190, gen: 3 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:34.39406448Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1, 1, 0, 0, 0]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:34.394831467Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:34.394864341Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 87908a59-a3f0-4ffe-b816-8c3b517a52d6, session_id: a8c3a5c1-fdb5-482e-92c7-cb01f8f3b190, gen: 3 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:26:38.523414719Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 87908a59-a3f0-4ffe-b816-8c3b517a52d6, session_id: a8c3a5c1-fdb5-482e-92c7-cb01f8f3b190, gen: 3 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:26:38.523483117Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:43771): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:38.523508533Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:63285","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:43.547512575Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 53409564-9108-4008-8949-a1c4f7515f17 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:43.547992041Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 53409564-9108-4008-8949-a1c4f7515f17, session_id: 1bcaa67b-55f5-489b-aed5-02732e2a8949, gen: 5 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:43.548032094Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 53409564-9108-4008-8949-a1c4f7515f17, session_id: 1bcaa67b-55f5-489b-aed5-02732e2a8949, gen: 5 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:43.548403809Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [11, 21, 31, 41, 51]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:43.549095099Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:26:43.549129993Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 53409564-9108-4008-8949-a1c4f7515f17, session_id: 1bcaa67b-55f5-489b-aed5-02732e2a8949, gen: 5 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:00.059698465Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 53409564-9108-4008-8949-a1c4f7515f17, session_id: 1bcaa67b-55f5-489b-aed5-02732e2a8949, gen: 5 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:00.059769752Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:63285): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:00.059814725Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:45539","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:05.086113648Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from ddc6622e-51ba-4db3-9609-67f2a5743e04 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:05.086593404Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: ddc6622e-51ba-4db3-9609-67f2a5743e04, session_id: 4ee9debe-3b54-408c-9526-c814d652efaf, gen: 7 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:05.086630538Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: ddc6622e-51ba-4db3-9609-67f2a5743e04, session_id: 4ee9debe-3b54-408c-9526-c814d652efaf, gen: 7 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:05.087029178Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [225, 225, 225, 225, 225]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:05.087601758Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:05.087638212Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: ddc6622e-51ba-4db3-9609-67f2a5743e04, session_id: 4ee9debe-3b54-408c-9526-c814d652efaf, gen: 7 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:17.785218398Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: ddc6622e-51ba-4db3-9609-67f2a5743e04, session_id: 4ee9debe-3b54-408c-9526-c814d652efaf, gen: 7 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:17.785276998Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:45539): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:17.785328018Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:48194","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:22.813066911Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:22.813510453Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 9 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:22.813550716Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 9 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:22.813946777Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [683, 1041, 1298, 1453, 1508]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:22.81467577Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:22.814702115Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 9 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:22.839671503Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 9 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:22.839711776Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:48194): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:22.839740482Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:65207","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:23.841296103Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:23.841565247Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 10 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:23.8416009Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 10 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:23.842014538Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1509, 1509, 1509, 1509, 1509]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:23.842696709Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:23.842721275Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 10 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:23.870303438Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 10 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:23.870341481Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:65207): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:23.870366237Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:43944","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:24.871724193Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:24.871909321Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 11 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:24.871948484Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 11 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:24.87231835Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1513, 1513, 1512, 1513, 1511]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:24.872951589Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:24.872982204Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 11 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:24.898866552Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 11 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:24.898912184Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:43944): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:24.898931941Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:59226","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:25.900174547Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:25.900362574Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 12 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:25.900393709Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 12 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:25.900756176Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1515, 1515, 1515, 1515, 1515]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:25.901417451Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:25.901471011Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 12 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:25.92545841Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 12 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:25.925487555Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:59226): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:25.925509282Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:64787","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:26.926359807Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:26.926721854Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 13 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:26.926761467Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 13 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:26.927024031Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1517, 1517, 1517, 1517, 1517]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:26.927600041Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:26.927629406Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 13 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:26.957063555Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 13 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:26.957117556Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:64787): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:26.957146231Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:54410","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:27.958462695Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:27.958629236Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 14 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:27.958675857Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 14 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:27.959128458Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1519, 1518, 1519, 1519, 1519]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:27.959781665Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:27.95980885Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 14 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:31.992428307Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 7a7d0ea7-ff90-4468-b21c-dd8f9ad99233, session_id: b7506d30-cf3a-46cf-b6a7-465a66a70ff7, gen: 14 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:31.992484597Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:54410): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:31.992559514Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:37206","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.056742234Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 0c088e9b-b706-4583-ab0d-e64b030031ad with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.05808538Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 5d3bd7d8-23db-4a59-b2cc-823810cce1ea, gen: 21 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.058125673Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 5d3bd7d8-23db-4a59-b2cc-823810cce1ea, gen: 21 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.058619257Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1519, 1518, 1521, 1522, 1522]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.059422347Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.059455301Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"accepted connection from 127.0.0.1:40909","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.803618766Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 0c088e9b-b706-4583-ab0d-e64b030031ad with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.80393642Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.803968305Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Attempting RW takeover from UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 5d3bd7d8-23db-4a59-b2cc-823810cce1ea, gen: 21 } to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:37.804400609Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Signaling to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 5d3bd7d8-23db-4a59-b2cc-823810cce1ea, gen: 21 } thread that UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 } is being promoted (read-write)","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:37.804444262Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.804473277Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Another upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 } promoted to active, shutting down connection for UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 5d3bd7d8-23db-4a59-b2cc-823810cce1ea, gen: 21 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:37.804503981Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:37206): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.804530717Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1524, 1524, 1524, 1524, 1524]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.805000875Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:37.805036339Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"accepted connection from 127.0.0.1:37134","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:38.544213173Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 0c088e9b-b706-4583-ab0d-e64b030031ad with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:38.544479546Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:38.54451516Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Attempting RW takeover from UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 } to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:38.544881536Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Signaling to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 } thread that UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 } is being promoted (read-write)","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:38.544935407Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:38.544965012Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Another upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 } promoted to active, shutting down connection for UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: e264a385-68f1-4a1e-be95-7ffcac661fcb, gen: 22 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:38.545000296Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:40909): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:38.545066824Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1526, 1526, 1526, 1526, 1526]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:38.545520695Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:38.545557399Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"accepted connection from 127.0.0.1:40404","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:39.287912099Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 0c088e9b-b706-4583-ab0d-e64b030031ad with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:39.288125431Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:39.288162225Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Attempting RW takeover from UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 } to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:39.288399354Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Signaling to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 } thread that UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 } is being promoted (read-write)","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:39.288441446Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:39.288466652Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Another upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 } promoted to active, shutting down connection for UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 7f851d8e-6055-444e-8704-01c749c89328, gen: 23 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:39.288491638Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:37134): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:39.288514274Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1529, 1529, 1529, 1529, 1529]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:39.288930441Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:39.288970644Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"accepted connection from 127.0.0.1:38124","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.056568915Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 0c088e9b-b706-4583-ab0d-e64b030031ad with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.056832519Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 50636406-cc58-4ad9-89ec-04b3d22d5618, gen: 25 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.056872522Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Attempting RW takeover from UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 } to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 50636406-cc58-4ad9-89ec-04b3d22d5618, gen: 25 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:40.057120968Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Signaling to UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 } thread that UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 50636406-cc58-4ad9-89ec-04b3d22d5618, gen: 25 } is being promoted (read-write)","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:40.057164061Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 50636406-cc58-4ad9-89ec-04b3d22d5618, gen: 25 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.057221521Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Another upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 50636406-cc58-4ad9-89ec-04b3d22d5618, gen: 25 } promoted to active, shutting down connection for UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 13e1c30e-f22b-4728-a7ee-36242ab18710, gen: 24 }","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:40.057255565Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:40404): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.0572838Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1531, 1531, 1531, 1531, 1531]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.057830065Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.057862679Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 50636406-cc58-4ad9-89ec-04b3d22d5618, gen: 25 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:40.823910029Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0c088e9b-b706-4583-ab0d-e64b030031ad, session_id: 50636406-cc58-4ad9-89ec-04b3d22d5618, gen: 25 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:40.823971759Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:38124): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.824003803Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:46631","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.851360545Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 0983d978-21f7-4702-ab47-142b459decc5 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.851714003Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0983d978-21f7-4702-ab47-142b459decc5, session_id: eb8f1def-c631-47f6-80a8-34e978bdf536, gen: 31 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.851753276Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 0983d978-21f7-4702-ab47-142b459decc5, session_id: eb8f1def-c631-47f6-80a8-34e978bdf536, gen: 31 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.852179412Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1534, 1534, 1534, 1534, 1534]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.852890538Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:40.852929311Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0983d978-21f7-4702-ab47-142b459decc5, session_id: eb8f1def-c631-47f6-80a8-34e978bdf536, gen: 31 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:44.873280508Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 0983d978-21f7-4702-ab47-142b459decc5, session_id: eb8f1def-c631-47f6-80a8-34e978bdf536, gen: 31 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:44.873348766Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:46631): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.87337937Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:37032","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.901065295Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from d05eff66-559c-4704-aa06-01664fe0b282 with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.901657072Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: d05eff66-559c-4704-aa06-01664fe0b282, session_id: f7577af5-fb27-4b5a-8a25-6a12762f8838, gen: 32 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.901693395Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: d05eff66-559c-4704-aa06-01664fe0b282, session_id: f7577af5-fb27-4b5a-8a25-6a12762f8838, gen: 32 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.902155975Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1535, 1535, 1535, 1535, 1535]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.902902605Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.902952076Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: d05eff66-559c-4704-aa06-01664fe0b282, session_id: f7577af5-fb27-4b5a-8a25-6a12762f8838, gen: 32 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:44.915443139Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: d05eff66-559c-4704-aa06-01664fe0b282, session_id: f7577af5-fb27-4b5a-8a25-6a12762f8838, gen: 32 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:44.915505818Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:37032): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:44.915532043Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"accepted connection from 127.0.0.1:49083","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:45.111296612Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"Connection request from 84739361-15b1-4cd3-8923-4a4362de512d with version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:45.111895508Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 84739361-15b1-4cd3-8923-4a4362de512d, session_id: 3d3a2f00-46eb-40d5-b893-86bcb3b44638, gen: 33 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:45.111935161Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 84739361-15b1-4cd3-8923-4a4362de512d, session_id: 3d3a2f00-46eb-40d5-b893-86bcb3b44638, gen: 33 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:45.112234479Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Current flush_numbers [0..12]: [1535, 1535, 1535, 1535, 1535]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:45.11268545Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:45.112718604Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"proc"}
{"msg":"Created copy dir \"/var/tmp/test_up/8820/00/000/000.copy\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.117843188Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"eid:0 Found repair files: [\"000\"]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.170347776Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Verify extent 0 still ready for copy","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.173489298Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8820/00/000/000.copy\" to \"/var/tmp/test_up/8820/00/000/000.replace\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.174000829Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Copy files from \"/var/tmp/test_up/8820/00/000/000.replace\" in \"/var/tmp/test_up/8820/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.175416003Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Move directory  \"/var/tmp/test_up/8820/00/000/000.replace\" to \"/var/tmp/test_up/8820/00/000/000.completed\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.17698283Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Created copy dir \"/var/tmp/test_up/8820/00/000/002.copy\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.180989201Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"eid:2 Found repair files: [\"002\"]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.213064031Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Verify extent 2 still ready for copy","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.215858684Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8820/00/000/002.copy\" to \"/var/tmp/test_up/8820/00/000/002.replace\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.216646587Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Copy files from \"/var/tmp/test_up/8820/00/000/002.replace\" in \"/var/tmp/test_up/8820/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.218426006Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Move directory  \"/var/tmp/test_up/8820/00/000/002.replace\" to \"/var/tmp/test_up/8820/00/000/002.completed\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.219717821Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Created copy dir \"/var/tmp/test_up/8820/00/000/003.copy\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.223792281Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"eid:3 Found repair files: [\"003\"]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.254972736Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Verify extent 3 still ready for copy","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.257802393Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8820/00/000/003.copy\" to \"/var/tmp/test_up/8820/00/000/003.replace\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.258235688Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Copy files from \"/var/tmp/test_up/8820/00/000/003.replace\" in \"/var/tmp/test_up/8820/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.260176789Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Move directory  \"/var/tmp/test_up/8820/00/000/003.replace\" to \"/var/tmp/test_up/8820/00/000/003.completed\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.261832091Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Created copy dir \"/var/tmp/test_up/8820/00/000/004.copy\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.266200019Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"eid:4 Found repair files: [\"004\"]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.296306842Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Verify extent 4 still ready for copy","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.299205907Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8820/00/000/004.copy\" to \"/var/tmp/test_up/8820/00/000/004.replace\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.299718087Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Copy files from \"/var/tmp/test_up/8820/00/000/004.replace\" in \"/var/tmp/test_up/8820/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.301416141Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Move directory  \"/var/tmp/test_up/8820/00/000/004.replace\" to \"/var/tmp/test_up/8820/00/000/004.completed\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.303026991Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Created copy dir \"/var/tmp/test_up/8820/00/000/001.copy\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.307189235Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"eid:1 Found repair files: [\"001\"]","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.33877588Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Verify extent 1 still ready for copy","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.341313418Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8820/00/000/001.copy\" to \"/var/tmp/test_up/8820/00/000/001.replace\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.341741063Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Copy files from \"/var/tmp/test_up/8820/00/000/001.replace\" in \"/var/tmp/test_up/8820/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.34371068Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"Move directory  \"/var/tmp/test_up/8820/00/000/001.replace\" to \"/var/tmp/test_up/8820/00/000/001.completed\"","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:47.345048707Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}
{"msg":"upstairs UpstairsConnection { upstairs_id: 84739361-15b1-4cd3-8923-4a4362de512d, session_id: 3d3a2f00-46eb-40d5-b893-86bcb3b44638, gen: 33 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:51.357938284Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 84739361-15b1-4cd3-8923-4a4362de512d, session_id: 3d3a2f00-46eb-40d5-b893-86bcb3b44638, gen: 33 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-03-01T16:27:51.358006422Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143,"task":"main"}
{"msg":"connection (127.0.0.1:49083): all done","v":0,"name":"crucible","level":30,"time":"2024-03-01T16:27:51.358030558Z","hostname":"ip-10-150-1-130.us-west-2.compute.internal","pid":1143}