{"msg":"Opened existing region file \"/var/tmp/test_up/8830/region.json\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.757117435Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Database read version 1","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.75735974Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Database write version 1","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.757381266Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"UUID: 12345678-0000-0000-0000-000000008830","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.757641968Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Blocks per extent:10 Total Extents: 5","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.757658644Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Crucible Version: Crucible Version: 0.0.1\nCommit SHA: ebef7f4917e579ad4649dc0478073aaafe487733\nCommit timestamp: 2024-02-08T06:19:45.000000000Z  branch: alan/downstairs-clone\nrustc: 1.75.0 stable x86_64-unknown-illumos\nCargo: x86_64-unknown-illumos  Debug: true Opt level: 0","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.757854698Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"Upstairs <-> Downstairs Message Version: 5","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.757880563Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"Repair listens on 0.0.0.0:12830 for path:\"/var/tmp/test_up/8830\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.758746791Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"repair"}
{"msg":"listening","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.759092827Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"local_addr":"0.0.0.0:12830","task":"repair"}
{"msg":"Using repair address: 0.0.0.0:12830","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.759185009Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"No SSL acceptor configured","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.759202246Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"downstairs listening on 0.0.0.0:8830","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.759217843Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"accepted connection from 127.0.0.1:61064","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.837149991Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"Connection request from 048d3599-bd8f-4b87-aebb-96d94c825035 with version 5","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.837538869Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"proc"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 048d3599-bd8f-4b87-aebb-96d94c825035, session_id: 0d953d9c-3e4f-4ccd-9bdf-79a4b19e0844, gen: 33 } connected, version 5","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.837560504Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"proc"}
{"msg":"UpstairsConnection { upstairs_id: 048d3599-bd8f-4b87-aebb-96d94c825035, session_id: 0d953d9c-3e4f-4ccd-9bdf-79a4b19e0844, gen: 33 } is now active (read-write)","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.838057932Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Current flush_numbers [0..12]: [1562, 1562, 1562, 1562, 1562]","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.838572516Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"proc"}
{"msg":"Downstairs has completed Negotiation","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.838596941Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"proc"}
{"msg":"Created copy dir \"/var/tmp/test_up/8830/00/000/001.copy\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.841199785Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"eid:1 Found repair files: [\"001\"]","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.913442995Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8830/00/000/001.copy\" to \"/var/tmp/test_up/8830/00/000/001.replace\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.917030326Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Copy files from \"/var/tmp/test_up/8830/00/000/001.replace\" in \"/var/tmp/test_up/8830/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.918315995Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Move directory  \"/var/tmp/test_up/8830/00/000/001.replace\" to \"/var/tmp/test_up/8830/00/000/001.completed\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.919570821Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Created copy dir \"/var/tmp/test_up/8830/00/000/004.copy\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.922637049Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"eid:4 Found repair files: [\"004\"]","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.955044332Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8830/00/000/004.copy\" to \"/var/tmp/test_up/8830/00/000/004.replace\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.957163257Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Copy files from \"/var/tmp/test_up/8830/00/000/004.replace\" in \"/var/tmp/test_up/8830/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.958232307Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Move directory  \"/var/tmp/test_up/8830/00/000/004.replace\" to \"/var/tmp/test_up/8830/00/000/004.completed\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.959144317Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Created copy dir \"/var/tmp/test_up/8830/00/000/003.copy\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.961962531Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"eid:3 Found repair files: [\"003\"]","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.992215276Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8830/00/000/003.copy\" to \"/var/tmp/test_up/8830/00/000/003.replace\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.994556319Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Copy files from \"/var/tmp/test_up/8830/00/000/003.replace\" in \"/var/tmp/test_up/8830/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.996011917Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Move directory  \"/var/tmp/test_up/8830/00/000/003.replace\" to \"/var/tmp/test_up/8830/00/000/003.completed\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:41.99734042Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Created copy dir \"/var/tmp/test_up/8830/00/000/002.copy\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:42.001150489Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"eid:2 Found repair files: [\"002\"]","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:42.032183948Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"1 repair files downloaded, move directory \"/var/tmp/test_up/8830/00/000/002.copy\" to \"/var/tmp/test_up/8830/00/000/002.replace\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:42.03452716Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Copy files from \"/var/tmp/test_up/8830/00/000/002.replace\" in \"/var/tmp/test_up/8830/00/000\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:42.035577634Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"Move directory  \"/var/tmp/test_up/8830/00/000/002.replace\" to \"/var/tmp/test_up/8830/00/000/002.completed\"","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:42.036910956Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}
{"msg":"upstairs UpstairsConnection { upstairs_id: 048d3599-bd8f-4b87-aebb-96d94c825035, session_id: 0d953d9c-3e4f-4ccd-9bdf-79a4b19e0844, gen: 33 } disconnected, 0 jobs left","v":0,"name":"crucible","level":40,"time":"2024-02-08T19:12:46.051022466Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"upstairs UpstairsConnection { upstairs_id: 048d3599-bd8f-4b87-aebb-96d94c825035, session_id: 0d953d9c-3e4f-4ccd-9bdf-79a4b19e0844, gen: 33 } was previously active, clearing","v":0,"name":"crucible","level":40,"time":"2024-02-08T19:12:46.051083145Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188,"task":"main"}
{"msg":"connection (127.0.0.1:61064): all done","v":0,"name":"crucible","level":30,"time":"2024-02-08T19:12:46.05110467Z","hostname":"ip-10-150-1-196.us-west-2.compute.internal","pid":1188}