/var/tmp/bins/dsc create --cleanup --region-count 3 --extent-size 10 --extent-count 5 --output-dir /tmp/test_up-build/dsc --ds-bin /var/tmp/bins/crucible-downstairs --region-dir /var/tmp/test_up-build Removing existing dsc directory "/tmp/test_up-build/dsc" Creating region directory at: /var/tmp/test_up-build Creating dsc directory at: /tmp/test_up-build/dsc Downstairs region 0 created at /var/tmp/test_up-build/8810 in 0.28919244 Downstairs region 1 created at /var/tmp/test_up-build/8820 in 0.018402956 Downstairs region 2 created at /var/tmp/test_up-build/8830 in 0.016916502 Created 3 regions /var/tmp/bins/dsc start --output-dir /tmp/test_up-build/dsc --ds-bin /var/tmp/bins/crucible-downstairs --region-dir /var/tmp/test_up-build --region-count 3 Using existing output directory "/tmp/test_up-build/dsc" Update our region info with: Some(RegionExtentInfo { block_size: 4096, blocks_per_extent: 10, extent_count: 5 }) start ds: 8810 start ds: 8820 start ds: 8830 start access at:127.0.0.1:9998 Starting downstairs at port 8810 Starting downstairs at port 8830 Starting downstairs at port 8820 Make output file at "/tmp/test_up-build/dsc/downstairs-8810.txt" Make output file at "/tmp/test_up-build/dsc/downstairs-8820.txt" Make output file at "/tmp/test_up-build/dsc/downstairs-8830.txt" [8810][0] initial start wait reports Starting [8830][2] initial start wait reports Starting [8820][1] initial start wait reports Starting Downstairs /var/tmp/test_up-build/8820 port 8820 PID:Some(1192) [8820][1] initial start wait reports Running Downstairs /var/tmp/test_up-build/8810 port 8810 PID:Some(1193) [8810][0] initial start wait reports Running Downstairs /var/tmp/test_up-build/8830 port 8830 PID:Some(1194) [8830][2] initial start wait reports Running All downstairs are running Feb 21 06:50:41.137 INFO listening, local_addr: 127.0.0.1:9998 Control access at:127.0.0.1:9998 Feb 21 06:50:46.181 INFO accepted connection, remote_addr: 127.0.0.1:63255, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.183 INFO request completed, latency_us: 498, response_code: 200, uri: /state/cid/0, method: GET, req_id: 2a5683bf-14ba-4f1f-b589-292817681a58, remote_addr: 127.0.0.1:63255, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.239 INFO accepted connection, remote_addr: 127.0.0.1:38197, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.239 INFO request completed, latency_us: 122, response_code: 200, uri: /state/cid/1, method: GET, req_id: 0ac4c2b7-f599-499c-859a-242deb92346c, remote_addr: 127.0.0.1:38197, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.292 INFO accepted connection, remote_addr: 127.0.0.1:52644, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.293 INFO request completed, latency_us: 119, response_code: 200, uri: /state/cid/2, method: GET, req_id: 74accd80-e256-48a7-a8aa-1c326c0492a0, remote_addr: 127.0.0.1:52644, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.345 INFO accepted connection, remote_addr: 127.0.0.1:52147, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc DisableRestartAll disable restart on all: 3 Feb 21 06:50:46.346 INFO request completed, latency_us: 171, response_code: 204, uri: /disablerestart/all, method: POST, req_id:[8810] Disable keep_running [8820] Disable keep_running 341635a0-1b46-4f92-bec7-34fe3d90daa0, remote_addr: 127.0.0.1:52147, local_addr[8830] Disable keep_running : 127.0.0.1:9998 Feb 21 06:50:46.452 INFO accepted connection, remote_addr: 127.0.0.1:61777, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.454 INFO request completed, latency_us: 288, response_code: 200, uri: /regioninfo, method: GET, req_id: 4aca01bc-07f3-481c-b813-64d0db411ce8, remote_addr: 127.0.0.1:61777, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.455 INFO request completed, latency_us: 111, response_code: 200, uri: /regioncount, method: GET, req_id: dbf5c2d7-9b2b-4d86-9282-784ec081ce85, remote_addr: 127.0.0.1:61777, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.456 INFO request completed, latency_us: 138, response_code: 200, uri: /port/cid/0, method: GET, req_id: 7ba7d6de-46d2-4596-a35e-e14f64fd9371, remote_addr: 127.0.0.1:61777, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.457 INFO request completed, latency_us: 90, response_code: 200, uri: /port/cid/1, method: GET, req_id: bc8d1ecb-420d-43d5-8961-44c6866c8818, remote_addr: 127.0.0.1:61777, local_addr: 127.0.0.1:9998 Feb 21 06:50:46.457 INFO request completed, latency_us: 88, response_code: 200, uri: /port/cid/2, method: GET, req_id: e80ecb7f-e1b3-47cd-952c-b6980cae7f47, remote_addr: 127.0.0.1:61777, local_addr: 127.0.0.1:9998 Feb 21 06:50:55.553 INFO accepted connection, remote_addr: 127.0.0.1:59939, local_addr: 127.0.0.1:9998 Feb 21 06:50:55.554 INFO request completed, latency_us: 162, response_code: 200, uri: /regioninfo, method: GET, req_id: 621564c6-0b91-4b11-b1b9-803cda54a184, remote_addr: 127.0.0.1:59939, local_addr: 127.0.0.1:9998 Feb 21 06:50:55.555 INFO request completed, latency_us: 95, response_code: 200, uri: /regioncount, method: GET, req_id: 6c2f5aa0-2345-4ffa-8a84-25da42a759fd, remote_addr: 127.0.0.1:59939, local_addr: 127.0.0.1:9998 Feb 21 06:50:55.555 INFO request completed, latency_us: 100, response_code: 200, uri: /port/cid/0, method: GET, req_id: 3c056f54-fe80-4df9-ad34-0d17016a2a6a, remote_addr: 127.0.0.1:59939, local_addr: 127.0.0.1:9998 Feb 21 06:50:55.556 INFO request completed, latency_us: 110, response_code: 200, uri: /port/cid/1, method: GET, req_id: fde05368-0457-41aa-96ea-733487a66bd4, remote_addr: 127.0.0.1:59939, local_addr: 127.0.0.1:9998 Feb 21 06:50:55.556 INFO request completed, latency_us: 88, response_code: 200, uri: /port/cid/2, method: GET, req_id: 2566f6c3-8523-48b0-a841-10aeab580366, remote_addr: 127.0.0.1:59939, local_addr: 127.0.0.1:9998 Feb 21 06:51:04.704 INFO accepted connection, remote_addr: 127.0.0.1:51798, local_addr: 127.0.0.1:9998 Feb 21 06:51:04.705 INFO request completed, latency_us: 178, response_code: 200, uri: /regioninfo, method: GET, req_id: ad869904-0399-4995-a169-72e479453790, remote_addr: 127.0.0.1:51798, local_addr: 127.0.0.1:9998 Feb 21 06:51:04.706 INFO request completed, latency_us: 86, response_code: 200, uri: /regioncount, method: GET, req_id: acd90fd3-7011-4dc9-a260-a6b9ff0ff400, remote_addr: 127.0.0.1:51798, local_addr: 127.0.0.1:9998 Feb 21 06:51:04.707 INFO request completed, latency_us: 121, response_code: 200, uri: /port/cid/0, method: GET, req_id: fb76918f-07a4-457f-8da9-f35a04b48f48, remote_addr: 127.0.0.1:51798, local_addr: 127.0.0.1:9998 Feb 21 06:51:04.707 INFO request completed, latency_us: 108, response_code: 200, uri: /port/cid/1, method: GET, req_id: 1944de15-9c37-4278-848f-b4965a206119, remote_addr: 127.0.0.1:51798, local_addr: 127.0.0.1:9998 Feb 21 06:51:04.708 INFO request completed, latency_us: 106, response_code: 200, uri: /port/cid/2, method: GET, req_id: a9f23fa7-eccf-40f5-9c32-ac359bf575a4, remote_addr: 127.0.0.1:51798, local_addr: 127.0.0.1:9998 Feb 21 06:51:22.592 INFO accepted connection, remote_addr: 127.0.0.1:61968, local_addr: 127.0.0.1:9998 Feb 21 06:51:22.593 INFO request completed, latency_us: 180, response_code: 200, uri: /regioninfo, method: GET, req_id: fb49d17c-9032-47fa-876b-885a14c95507, remote_addr: 127.0.0.1:61968, local_addr: 127.0.0.1:9998 Feb 21 06:51:22.594 INFO request completed, latency_us: 89, response_code: 200, uri: /regioncount, method: GET, req_id: 34760ea4-0ec3-47b3-906a-cbc0bdbc9924, remote_addr: 127.0.0.1:61968, local_addr: 127.0.0.1:9998 Feb 21 06:51:22.594 INFO request completed, latency_us: 104, response_code: 200, uri: /port/cid/0, method: GET, req_id: 11df8003-0861-4437-a1f4-9bedf7ced94a, remote_addr: 127.0.0.1:61968, local_addr: 127.0.0.1:9998 Feb 21 06:51:22.595 INFO request completed, latency_us: 90, response_code: 200, uri: /port/cid/1, method: GET, req_id: 58fc3465-2a3e-4c29-a4f5-6702399d7060, remote_addr: 127.0.0.1:61968, local_addr: 127.0.0.1:9998 Feb 21 06:51:22.595 INFO request completed, latency_us: 107, response_code: 200, uri: /port/cid/2, method: GET, req_id: af16b402-d7e0-4f88-9e9e-34b21b1b65aa, remote_addr: 127.0.0.1:61968, local_addr: 127.0.0.1:9998 Feb 21 06:51:37.284 INFO accepted connection, remote_addr: 127.0.0.1:63033, local_addr: 127.0.0.1:9998 Feb 21 06:51:37.285 INFO request completed, latency_us: 167, response_code: 200, uri: /regioninfo, method: GET, req_id: c02c5c19-ab4c-4556-bad3-f6d3c8c092bc, remote_addr: 127.0.0.1:63033, local_addr: 127.0.0.1:9998 Feb 21 06:51:37.286 INFO request completed, latency_us: 106, response_code: 200, uri: /regioncount, method: GET, req_id: 3c802aa3-a98d-4643-b0c4-002834416677, remote_addr: 127.0.0.1:63033, local_addr: 127.0.0.1:9998 Feb 21 06:51:37.286 INFO request completed, latency_us: 124, response_code: 200, uri: /port/cid/0, method: GET, req_id: 3ac67584-d8ec-46da-8a60-c9f2e1ec8e6d, remote_addr: 127.0.0.1:63033, local_addr: 127.0.0.1:9998 Feb 21 06:51:37.287 INFO request completed, latency_us: 103, response_code: 200, uri: /port/cid/1, method: GET, req_id: c6034d70-78bb-4aea-bde2-1b9fe6395254, remote_addr: 127.0.0.1:63033, local_addr: 127.0.0.1:9998 Feb 21 06:51:37.288 INFO request completed, latency_us: 89, response_code: 200, uri: /port/cid/2, method: GET, req_id: dbe1acff-bc84-40ad-9e60-be4dc727aab7, remote_addr: 127.0.0.1:63033, local_addr: 127.0.0.1:9998 Feb 21 06:52:39.454 INFO accepted connection, remote_addr: 127.0.0.1:43432, local_addr: 127.0.0.1:9998 Feb 21 06:52:39.455 INFO request completed, latency_us: 170, response_code: 200, uri: /regioninfo, method: GET, req_id: 226c5337-3717-4176-ab66-bed80d5ad730, remote_addr: 127.0.0.1:43432, local_addr: 127.0.0.1:9998 Feb 21 06:52:39.456 INFO request completed, latency_us: 89, response_code: 200, uri: /regioncount, method: GET, req_id: d6286e59-158d-4136-8258-407c4c8167fd, remote_addr: 127.0.0.1:43432, local_addr: 127.0.0.1:9998 Feb 21 06:52:39.457 INFO request completed, latency_us: 100, response_code: 200, uri: /port/cid/0, method: GET, req_id: 60a8938f-d636-4f13-a29f-bbaddb9b509b, remote_addr: 127.0.0.1:43432, local_addr: 127.0.0.1:9998 Feb 21 06:52:39.457 INFO request completed, latency_us: 91, response_code: 200, uri: /port/cid/1, method: GET, req_id: 16d02408-96e5-4a4f-bb77-f9e444be2def, remote_addr: 127.0.0.1:43432, local_addr: 127.0.0.1:9998 Feb 21 06:52:39.458 INFO request completed, latency_us: 92, response_code: 200, uri: /port/cid/2, method: GET, req_id: 20b1e910-4915-4c0f-baf5-e30ec6d5ab4e, remote_addr: 127.0.0.1:43432, local_addr: 127.0.0.1:9998 Feb 21 06:52:43.550 INFO accepted connection, remote_addr: 127.0.0.1:46770, local_addr: 127.0.0.1:9998 Feb 21 06:52:43.551 INFO request completed, latency_us: 182, response_code: 200, uri: /regioninfo, method: GET, req_id: dffc5a9a-e0c6-487b-921b-b68a5846392a, remote_addr: 127.0.0.1:46770, local_addr: 127.0.0.1:9998 Feb 21 06:52:43.552 INFO request completed, latency_us: 123, response_code: 200, uri: /regioncount, method: GET, req_id: aaebb1bc-c122-4040-a393-95fa4d40358e, remote_addr: 127.0.0.1:46770, local_addr: 127.0.0.1:9998 Feb 21 06:52:43.553 INFO request completed, latency_us: 121, response_code: 200, uri: /port/cid/0, method: GET, req_id: 0238de59-70ed-482e-9a61-1a9dd8c786e3, remote_addr: 127.0.0.1:46770, local_addr: 127.0.0.1:9998 Feb 21 06:52:43.553 INFO request completed, latency_us: 106, response_code: 200, uri: /port/cid/1, method: GET, req_id: 4b3479a5-1e6b-4d02-b501-5f46a5fe8374, remote_addr: 127.0.0.1:46770, local_addr: 127.0.0.1:9998 Feb 21 06:52:43.554 INFO request completed, latency_us: 86, response_code: 200, uri: /port/cid/2, method: GET, req_id: fcb34e20-262e-4ac8-9566-6b5d49b4892b, remote_addr: 127.0.0.1:46770, local_addr: 127.0.0.1:9998 Feb 21 06:52:47.630 INFO accepted connection, remote_addr: 127.0.0.1:43252, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc DisableRestartAll disable restart on all: 3 Feb 21 06:52:47.630 INFO request completed, latency_us: 148, response_code: 204, [8810] Disable keep_running uri:[8830] Disable keep_running [8820] Disable keep_running /disablerestart/all, method: POST, req_id: 7b8c5b44-c826-4e26-8c4f-c90f06348faa, remote_addr: 127.0.0.1:43252, local_addr: 127.0.0.1:9998 Feb 21 06:52:47.684 INFO accepted connection, remote_addr: 127.0.0.1:40149, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(2) stop 2 [8830] Got stop action so:false kr:false Feb 21 06:52:47.684 INFO request completed, latency_us: 161, response_code: 204, uri: /stop/cid/2, method: POST, req_id: 6a84b362-5d03-4186-a429-6f28fa68a2a8, remote_addr: 127.0.0.1:40149, local_addr: 127.0.0.1:9998 [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit Feb 21 06:52:47.738 INFO accepted connection, remote_addr: 127.0.0.1:54033, local_addr: 127.0.0.1:9998 Feb 21 06:52:47.738 INFO request completed, latency_us: 136, response_code: 200, uri: /state/cid/2, method: GET, req_id: 62ce1a5a-74af-4ff1-a741-8e7f929ad918, remote_addr: 127.0.0.1:54033, local_addr: 127.0.0.1:9998 Feb 21 06:52:47.796 INFO accepted connection, remote_addr: 127.0.0.1:57034, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(2) start 2 Feb 21 06:52:47.797 INFO request completed, latency_us: 178, response_code: 204, uri: /start/cid/2, method: POST, req_id: 668d5a1a-bb39-49e3-959a-c113c703b669, remote_addr: 127.0.0.1:57034, local_addr: 127.0.0.1:9998 Feb 21 06:52:48.091 INFO accepted connection, remote_addr: 127.0.0.1:39999, local_addr: 127.0.0.1:9998 Feb 21 06:52:48.092 INFO request completed, latency_us: 167, response_code: 200, uri: /regioninfo, method: GET, req_id: 868ba43e-52bc-4a60-a4e9-b27fca4af893, remote_addr: 127.0.0.1:39999, local_addr: 127.0.0.1:9998 Feb 21 06:52:48.093 INFO request completed, latency_us: 129, response_code: 200, uri: /regioncount, method: GET, req_id: 9a303b91-7ba9-46f7-ac16-61b59d5dd922, remote_addr: 127.0.0.1:39999, local_addr: 127.0.0.1:9998 Feb 21 06:52:48.094 INFO request completed, latency_us: 101, response_code: 200, uri: /port/cid/0, method: GET, req_id: 4c46655b-68cc-43ed-9aae-011b7af3cda7, remote_addr: 127.0.0.1:39999, local_addr: 127.0.0.1:9998 Feb 21 06:52:48.094 INFO request completed, latency_us: 91, response_code: 200, uri: /port/cid/1, method: GET, req_id: ea2f8e93-a8f1-4db3-8ad8-543dda4b1bf0, remote_addr: 127.0.0.1:39999, local_addr: 127.0.0.1:9998 Feb 21 06:52:48.095 INFO request completed, latency_us: 91, response_code: 200, uri: /port/cid/2, method: GET, req_id: 01fa3f26-7279-4cf2-80c9-80fa04f365e8, remote_addr: 127.0.0.1:39999, local_addr: 127.0.0.1:9998 [8830] got start action [8830] I am going to restart Starting downstairs at port 8830 Make output file at "/tmp/test_up-build/dsc/downstairs-8830.txt" [8830][2] reports Starting Downstairs /var/tmp/test_up-build/8830 port 8830 PID:Some(1242) [8830][2] reports Running Feb 21 06:53:02.270 INFO accepted connection, remote_addr: 127.0.0.1:54927, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Shutdown Shutdown Shut it down Feb 21 06:53:02.271 INFO request completed, latency_us: 251, response_code: 204, uri: /shutdown, method:[8810] Disable keep_running [8810] Got stop action so:false kr:false POST, req_id: 3f447aee-3d93-424f-b0f0-92891966330d, remote_addr: 127.0.0.[8820] Disable keep_running 1:54927, local_addr: 127.0.0.1:9998 [8830] Disable keep_running [8830] Got stop action so:false kr:false [8820] Got stop action so:false kr:false [8820] Exited with: ExitStatus(unix_wait_status(9)) [8830] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit [8830][2] reports Exit [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit /var/tmp/bins/dsc create --cleanup --region-count 4 --extent-count 300 --block-size 4096 --output-dir /tmp/test_up-build/dsc --ds-bin /var/tmp/bins/crucible-downstairs --region-dir /var/tmp/test_up-build Removing existing dsc directory "/tmp/test_up-build/dsc" Removing existing region "/var/tmp/test_up-build" Creating region directory at: /var/tmp/test_up-build Creating dsc directory at: /tmp/test_up-build/dsc Downstairs region 0 created at /var/tmp/test_up-build/8810 in 0.026211524 Downstairs region 1 created at /var/tmp/test_up-build/8820 in 0.023615835 Downstairs region 2 created at /var/tmp/test_up-build/8830 in 0.022494433 Downstairs region 3 created at /var/tmp/test_up-build/8840 in 0.023262413 Created 4 regions /var/tmp/bins/dsc start --region-count 4 --output-dir /tmp/test_up-build/dsc --ds-bin /var/tmp/bins/crucible-downstairs --region-dir /var/tmp/test_up-build Using existing output directory "/tmp/test_up-build/dsc" Update our region info with: Some(RegionExtentInfo { block_size: 4096, blocks_per_extent: 100, extent_count: 100 }) start ds: 8810 start access at:127.0.0.1:9998 start ds: 8820 start ds: 8830 Starting downstairs at port 8810 start ds: 8840 Make output file at "/tmp/test_up-build/dsc/downstairs-8810.txt" Starting downstairs at port 8820 [8810][0] initial start wait reports Starting Make output file at "/tmp/test_up-build/dsc/downstairs-8820.txt" [8820][1] initial start wait reports Starting Starting downstairs at port 8830 Make output file at "/tmp/test_up-build/dsc/downstairs-8830.txt" Starting downstairs at port 8840 [8830][2] initial start wait reports Starting Make output file at "/tmp/test_up-build/dsc/downstairs-8840.txt" [8840][3] initial start wait reports Starting Downstairs /var/tmp/test_up-build/8830 port 8830 PID:Some(1256) [8830][2] initial start wait reports Running Downstairs /var/tmp/test_up-build/8810 port 8810 PID:Some(1257) [8810][0] initial start wait reports Running Downstairs /var/tmp/test_up-build/8820 port 8820 PID:Some(1258) [8820][1] initial start wait reports Running Downstairs /var/tmp/test_up-build/8840 port 8840 PID:Some(1259) [8840][3] initial start wait reports Running All downstairs are running Feb 21 06:53:07.412 INFO listening, local_addr: 127.0.0.1:9998 Control access at:127.0.0.1:9998 Feb 21 06:53:12.452 INFO accepted connection, remote_addr: 127.0.0.1:45506, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.454 INFO request completed, latency_us: 304, response_code: 200, uri: /state/cid/0, method: GET, req_id: b983cb44-63be-47f9-b8b9-db9b6ffa1c56, remote_addr: 127.0.0.1:45506, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.510 INFO accepted connection, remote_addr: 127.0.0.1:49817, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.511 INFO request completed, latency_us: 126, response_code: 200, uri: /state/cid/1, method: GET, req_id: b9337f3c-2efa-4523-b382-6c81c978468f, remote_addr: 127.0.0.1:49817, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.564 INFO accepted connection, remote_addr: 127.0.0.1:39528, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.565 INFO request completed, latency_us: 134, response_code: 200, uri: /state/cid/2, method: GET, req_id: aae59a37-c386-466f-a3ab-aacd331a42ea, remote_addr: 127.0.0.1:39528, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.619 INFO accepted connection, remote_addr: 127.0.0.1:32843, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.619 INFO request completed, latency_us: 151, response_code: 200, uri: /state/cid/3, method: GET, req_id: 669be57a-9a5e-4df1-897a-b028134d5f98, remote_addr: 127.0.0.1:32843, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.674 INFO accepted connection, remote_addr: 127.0.0.1:55467, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.675 INFO request completed, latency_us: 183, response_code: 200, uri: /port/cid/3, method: GET, req_id: b0e3dada-0438-4648-a5b6-edbb848b80de, remote_addr: 127.0.0.1:55467, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.736 INFO accepted connection, remote_addr: 127.0.0.1:50167, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.736 INFO request completed, latency_us: 193, response_code: 200, uri: /regioninfo, method: GET, req_id: ecade63b-ad1c-456b-b09c-4f202e2ab3d1, remote_addr: 127.0.0.1:50167, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.737 INFO request completed, latency_us: 118, response_code: 200, uri: /regioncount, method: GET, req_id: 4af07a3f-0b10-4ee4-9e29-26a4150c5d2d, remote_addr: 127.0.0.1:50167, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.738 INFO request completed, latency_us: 103, response_code: 200, uri: /port/cid/0, method: GET, req_id: cfbdad6c-0476-4ede-b9f1-f0fb02c856d9, remote_addr: 127.0.0.1:50167, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.739 INFO request completed, latency_us: 90, response_code: 200, uri: /port/cid/1, method: GET, req_id: 61c3cacb-5b37-479d-85fe-e082a015631c, remote_addr: 127.0.0.1:50167, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.739 INFO request completed, latency_us: 90, response_code: 200, uri: /port/cid/2, method: GET, req_id: 07290ed3-b21f-4ea5-ba96-10617e2f66f0, remote_addr: 127.0.0.1:50167, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.775 INFO accepted connection, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.775 INFO request completed, latency_us: 108, response_code: 200, uri: /regioncount, method: GET, req_id: 019997f6-f102-4d0c-8661-04137c012a32, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Feb 21 06:53:12.798 INFO request completed, [8810] Got stop action so:false kr:false latency_us: 247, response_code: 204, uri: /stop/cid/0, method: POST, req_id: b0474e58-d794-4eb7-b366-ef264536057c, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:53:12.799 INFO request completed, latency_us: 183, response_code: 200, uri: /state/cid/0, method: GET, req_id: d76413f6-a041-4b15-b32d-3082810392f6, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Feb 21 06:53:16.801 INFO request completed, latency_us: 233, response_code: 200, uri: /state/cid/0, method: GET, req_id: 1a7c6282-bd7a-4c35-bd33-0ad16906dac7, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Feb 21 06:53:16.824 INFO request completed, latency_us: 206, response_code: 204, uri: /start/cid/0, method: POST, req_id: f0e8ca59-e3eb-4531-a46f-9f23f620ce84, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:53:16.824 INFO request completed, latency_us: 145, response_code: 200, uri: /state/cid/0, method: GET, req_id: 9b347e86-75cf-4256-ae19-630c80baa9ce, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8810] got start action [8810] I am going to restart Starting downstairs at port 8810 Make output file at "/tmp/test_up-build/dsc/downstairs-8810.txt" [8810][0] reports Starting Downstairs /var/tmp/test_up-build/8810 port 8810 PID:Some(1267) [8810][0] reports Running Feb 21 06:53:20.827 INFO request completed, latency_us: 327, response_code: 200, uri: /state/cid/0, method: GET, req_id: 18de46cc-78ce-4f17-8160-9e8fd51584fc, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(1) stop 1 Feb 21 06:53:51.101 INFO request completed, latency_us: 205, response_code: 204, uri: /stop/cid/1, method: POST, req_id: 4be03a3c-5b19-4c74-8bb4-112d40d98dd9, remote_addr: 127.0.0.1:[8820] Got stop action so:false kr:false 50564, local_addr: 127.0.0.1:9998 Feb 21 06:53:51.102 INFO request completed, latency_us: 134, response_code: 200, uri: /state/cid/1, method: GET, req_id: 651318cb-4eb7-4d5f-a8fd-b7db5ca25796, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8820] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit Feb 21 06:53:55.104 INFO request completed, latency_us: 286, response_code: 200, uri: /state/cid/1, method: GET, req_id: 69a01b7f-f925-4c42-b155-d831d01d7d98, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(1) start 1 Feb 21 06:53:55.127 INFO request completed, latency_us: 147, response_code: 204, uri: /start/cid/1, method: POST, req_id: 59306b4e-e710-4a82-9f70-f250c72eb99a, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:53:55.127 INFO request completed, latency_us: 94, response_code: 200, uri: /state/cid/1, method: GET, req_id: eb812328-96cf-4981-9752-bd30b870c7c7, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8820] got start action [8820] I am going to restart Starting downstairs at port 8820 Make output file at "/tmp/test_up-build/dsc/downstairs-8820.txt" [8820][1] reports Starting Downstairs /var/tmp/test_up-build/8820 port 8820 PID:Some(1268) [8820][1] reports Running Feb 21 06:53:59.131 INFO request completed, latency_us: 367, response_code: 200, uri: /state/cid/1, method: GET, req_id: 58f25f08-e591-4eab-9028-bfedf144f293, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(2) stop 2 Feb 21 06:54:29.407 INFO request completed, latency_us: 206, response_code: 204, uri[8830] Got stop action so:false kr:false : /stop/cid/2, method: POST, req_id: cbe0915d-f356-469c-adfc-eb4343f73646, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:54:29.408 INFO request completed, latency_us: 280, response_code: 200, uri: /state/cid/2, method: GET, req_id: 8551aefd-1ede-4691-9f6d-bc62aa559926, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit Feb 21 06:54:33.411 INFO request completed, latency_us: 211, response_code: 200, uri: /state/cid/2, method: GET, req_id: 65c81e98-8f9d-4dbb-9b87-13fea7a3ad9c, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(2) start 2 Feb 21 06:54:33.434 INFO request completed, latency_us: 125, response_code: 204, uri: /start/cid/2, method: POST, req_id: 487c1c60-6d70-47be-98a9-75aadd2ed6c9, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:54:33.435 INFO request completed, latency_us: 108, response_code: 200, uri: /state/cid/2, method: GET, req_id: e5e6b543-0fd2-4b0c-98c0-0b2afd8ebd07, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8830] got start action [8830] I am going to restart Starting downstairs at port 8830 Make output file at "/tmp/test_up-build/dsc/downstairs-8830.txt" [8830][2] reports Starting Downstairs /var/tmp/test_up-build/8830 port 8830 PID:Some(1269) [8830][2] reports Running Feb 21 06:54:37.437 INFO request completed, latency_us: 535, response_code: 200, uri: /state/cid/2, method: GET, req_id: 03e33866-3032-458c-81bd-7487f67b85cf, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(3) stop 3 Feb 21 06:55:07.713 INFO request completed, latency_us[8840] Got stop action so:false kr:false : 210, response_code: 204, uri: /stop/cid/3, method: POST, req_id: e5a01d3b-7968-4377-8210-2dc03e87bbe7, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:55:07.714 INFO request completed, latency_us: 151, response_code: 200, uri: /state/cid/3, method: GET, req_id: 9b05ca90-7cd9-4c43-8c26-4487e61b4fdd, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8840] Exited with: ExitStatus(unix_wait_status(9)) [8840][3] reports Exit Feb 21 06:55:11.717 INFO request completed, latency_us: 290, response_code: 200, uri: /state/cid/3, method: GET, req_id: 83adad4a-62af-46fa-a51a-4c2b74ee934e, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(3) start 3 Feb 21 06:55:11.741 INFO request completed, latency_us: 157, response_code: 204, uri: /start/cid/3, method: POST, req_id: 0c08a102-eb7a-49b0-b117-d7e9df35085f, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:55:11.741 INFO request completed, latency_us: 94, response_code: 200, uri: /state/cid/3, method: GET, req_id: 58f03b3d-de34-436f-b7a5-e8d7a7ef959b, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:55:15.743 INFO request completed, latency_us: 206, response_code: 200, uri: /state/cid/3, method: GET, req_id: ae801556-1b12-438d-b891-22705ba16296, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:55:19.746 INFO request completed, latency_us: 291, response_code: 200, uri: /state/cid/3, method: GET, req_id: 280e2ed4-37c0-40a0-9a87-13777512a0c3, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 [8840] got start action [8840] I am going to restart Starting downstairs at port 8840 Make output file at "/tmp/test_up-build/dsc/downstairs-8840.txt" [8840][3] reports Starting Downstairs /var/tmp/test_up-build/8840 port 8840 PID:Some(1270) [8840][3] reports Running Feb 21 06:55:23.748 INFO request completed, latency_us: 272, response_code: 200, uri: /state/cid/3, method: GET, req_id: 0ded402a-bb86-4967-ac48-e77e2b6368c2, remote_addr: 127.0.0.1:50564, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.067 INFO accepted connection, remote_addr: 127.0.0.1:42514, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.068 INFO request completed, latency_us: 164, response_code: 200, uri: /regioninfo, method: GET, req_id: 2ac24f1e-1261-4008-b13d-91a9f2ca5d60, remote_addr: 127.0.0.1:42514, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.069 INFO request completed, latency_us: 93, response_code: 200, uri: /regioncount, method: GET, req_id: 4d641259-757f-444c-b421-1c2bb0731bb3, remote_addr: 127.0.0.1:42514, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.070 INFO request completed, latency_us: 99, response_code: 200, uri: /port/cid/0, method: GET, req_id: b75d224f-871d-40ef-be22-6bc4eb05e9c2, remote_addr: 127.0.0.1:42514, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.070 INFO request completed, latency_us: 90, response_code: 200, uri: /port/cid/1, method: GET, req_id: 93ea7850-49bf-48b0-9c0c-2aa4067dd6ab, remote_addr: 127.0.0.1:42514, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.071 INFO request completed, latency_us: 90, response_code: 200, uri: /port/cid/2, method: GET, req_id: 21b74cc0-bafa-4b74-9b5d-ba1db843dc54, remote_addr: 127.0.0.1:42514, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.105 INFO accepted connection, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.106 INFO request completed, latency_us: 138, response_code: 200, uri: /regioncount, method: GET, req_id: b0c5aa55-6b13-4b3f-a83d-67cce30fc329, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Feb 21 06:55:54.543 INFO request completed, latency_us: 244[8810] Got stop action so:false kr:false , response_code: 204, uri: /stop/cid/0, method: POST, req_id: dd9d7162-1f2a-4a6e-8454-2229ddcd7396, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Feb 21 06:55:54.544 INFO request completed, latency_us: 121, response_code: 200, uri: /state/cid/0, method: GET, req_id: d631e8bf-dbc3-4a5c-8226-07eca494c744, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Feb 21 06:55:58.546 INFO request completed, latency_us: 197, response_code: 200, uri: /state/cid/0, method: GET, req_id: 3c582e5b-9e7f-48cc-87a3-657027bb8b65, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Feb 21 06:56:23.297 INFO request completed, latency_us: 225, response_code: 204, uri: /start/cid/0, method: POST, req_id: edca74e9-89f2-4a40-af28-c215672a0426, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8810] got start action [8810] I am going to restart Starting downstairs at port 8810 Make output file at "/tmp/test_up-build/dsc/downstairs-8810.txt" [8810][0] reports Starting Downstairs /var/tmp/test_up-build/8810 port 8810 PID:Some(1272) [8810][0] reports Running Main task has work to do, go find it got dsc Stop(1) stop 1 Feb 21 06:56:27.321 INFO [8820] Got stop action so:false kr:false request completed, latency_us: 304, response_code: 204, uri: /stop/cid/1, method: POST, req_id: a1517145-12fc-41c4-8c5b-c6dea58753f2, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Feb 21 06:56:27.322 INFO request completed, latency_us: 143, response_code: 200, uri: /state/cid/1, method: GET, req_id: cc0771a5-c6b2-4d06-b4c3-9da7f02a0122, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8820] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit Feb 21 06:56:31.324 INFO request completed, latency_us: 202, response_code: 200, uri: /state/cid/1, method: GET, req_id: f293a6f8-5748-448f-9c63-bec84c89f809, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(1) start 1 Feb 21 06:56:56.073 INFO request completed, latency_us: 231, response_code: 204, uri: /start/cid/1, method: POST, req_id: 1bb7736c-08ec-4a1b-8e3a-cb486f7f4a12, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8820] got start action [8820] I am going to restart Starting downstairs at port 8820 Make output file at "/tmp/test_up-build/dsc/downstairs-8820.txt" [8820][1] reports Starting Downstairs /var/tmp/test_up-build/8820 port 8820 PID:Some(1273) [8820][1] reports Running Main task has work to do, go find it got dsc Stop(2) stop 2 Feb 21 06:57:00.100 INFO request completed, latency_us: 316, response_code: 204, uri: /stop/cid/2, method: POST, req_id: d9390169-33cc-4a61-90b0-0e6bded19d76, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8830] Got stop action so:false kr:false Feb 21 06:57:00.101 INFO request completed, latency_us: 122, response_code: 200, uri: /state/cid/2, method: GET, req_id: 422eb739-c947-429b-a7da-76b1eaf7a6e8, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit Feb 21 06:57:04.104 INFO request completed, latency_us: 202, response_code: 200, uri: /state/cid/2, method: GET, req_id: 5ef521f5-6a52-49c6-8371-78c50de4d58f, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(2) start 2 Feb 21 06:57:28.864 INFO request completed, latency_us: 227, response_code: 204, uri: /start/cid/2, method: POST, req_id: 2f53555d-43f5-44cf-ab54-420b2788b9c6, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8830] got start action [8830] I am going to restart Starting downstairs at port 8830 Make output file at "/tmp/test_up-build/dsc/downstairs-8830.txt" [8830][2] reports Starting Downstairs /var/tmp/test_up-build/8830 port 8830 PID:Some(1274) [8830][2] reports Running Main task has work to do, go find it got dsc Stop(3) stop 3 Feb 21 06:57:32.891[8840] Got stop action so:false kr:false INFO request completed, latency_us: 305, response_code: 204, uri: /stop/cid/3, method: POST, req_id: 0131eb79-c99c-446d-b9c9-255f038265a6, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Feb 21 06:57:32.892 INFO request completed, latency_us: 144, response_code: 200, uri: /state/cid/3, method: GET, req_id: d7b1c857-2d5b-461f-a5a3-8b7b8ddeab2e, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8840] Exited with: ExitStatus(unix_wait_status(9)) [8840][3] reports Exit Feb 21 06:57:36.893 INFO request completed, latency_us: 343, response_code: 200, uri: /state/cid/3, method: GET, req_id: 5d151f13-e2de-4582-8d63-e8c3259b5933, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(3) start 3 Feb 21 06:58:01.659 INFO request completed, latency_us: 230, response_code: 204, uri: /start/cid/3, method: POST, req_id: e0eb909d-d009-48ee-8cf3-7d1003228a53, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8840] got start action [8840] I am going to restart Starting downstairs at port 8840 Make output file at "/tmp/test_up-build/dsc/downstairs-8840.txt" [8840][3] reports Starting Downstairs /var/tmp/test_up-build/8840 port 8840 PID:Some(1275) [8840][3] reports Running Main task has work to do, go find it got dsc Stop(0) stop 0 [8810] Got stop action so:false kr:false Feb 21 06:58:05.693 INFO request completed, latency_us: 321, response_code: 204, uri: /stop/cid/0, method: POST, req_id: b51c2e95-573d-4522-8e58-714359597d9d, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Feb 21 06:58:05.694 INFO request completed, latency_us: 132, response_code: 200, uri: /state/cid/0, method: GET, req_id: 35e212a0-713d-4107-a18e-1a7b773d55bb, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Feb 21 06:58:09.697 INFO request completed, latency_us: 330, response_code: 200, uri: /state/cid/0, method: GET, req_id: e724ae46-11ea-4097-b4d2-d989a47a9694, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Feb 21 06:58:34.450 INFO request completed, latency_us: 237, response_code: 204, uri: /start/cid/0, method: POST, req_id: a5e33a7f-4bc5-4398-9d6d-0dc884e3c0d5, remote_addr: 127.0.0.1:33725, local_addr: 127.0.0.1:9998 Feb 21 06:58:38.518 INFO accepted connection, remote_addr: 127.0.0.1:35483, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Shutdown Shutdown Feb 21 06:58:38.519Shut it down [8830] Disable keep_running INFO[8820] Disable keep_running request completed, latency_us: 163, response_code: 204[8820] Got stop action so:false kr:false , [8840] Disable keep_running uri: /shutdown[8830] Got stop action so:false kr:false , method: POST, req_id: 7bb5e83e-610f-44e6-8372-512471d26949, remote_addr: 127.0.0.1:35483, local_addr: 127.0.0.1:9998 [8840] Got stop action so:false kr:false [8840] Exited with: ExitStatus(unix_wait_status(9)) [8840][3] reports Exit [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit [8820] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit