/var/tmp/bins/dsc create --encrypted --cleanup --region-count 6 --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.17916001 Downstairs region 1 created at /var/tmp/test_up-build/8820 in 0.01175618 Downstairs region 2 created at /var/tmp/test_up-build/8830 in 0.010852589 Downstairs region 3 created at /var/tmp/test_up-build/8840 in 0.010752081 Downstairs region 4 created at /var/tmp/test_up-build/8850 in 0.010789376 Downstairs region 5 created at /var/tmp/test_up-build/8860 in 0.010656521 Created 6 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 6 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 access at:127.0.0.1:9998 start ds: 8820 start ds: 8830 start ds: 8840 start ds: 8850 start ds: 8860 Starting downstairs at port 8810 Starting downstairs at port 8820 Starting downstairs at port 8830 Starting downstairs at port 8840 Make output file at "/tmp/test_up-build/dsc/downstairs-8810.txt" Make output file at "/tmp/test_up-build/dsc/downstairs-8830.txt" Make output file at "/tmp/test_up-build/dsc/downstairs-8820.txt" Make output file at "/tmp/test_up-build/dsc/downstairs-8840.txt" Starting downstairs at port 8850 Make output file at "/tmp/test_up-build/dsc/downstairs-8850.txt" Starting downstairs at port 8860 [8810][0] initial start wait reports Starting Make output file at "/tmp/test_up-build/dsc/downstairs-8860.txt" [8820][1] initial start wait reports Starting [8830][2] initial start wait reports Starting [8840][3] initial start wait reports Starting [8850][4] initial start wait reports Starting [8860][5] initial start wait reports Starting Downstairs /var/tmp/test_up-build/8860 port 8860 PID:Some(1140) [8860][5] initial start wait reports Running Downstairs /var/tmp/test_up-build/8830 port 8830 PID:Some(1145) Downstairs /var/tmp/test_up-build/8820 port 8820 PID:Some(1142) Downstairs /var/tmp/test_up-build/8810 port 8810 PID:Some(1143) Downstairs /var/tmp/test_up-build/8850 port 8850 PID:Some(1144) Downstairs /var/tmp/test_up-build/8840 port 8840 PID:Some(1141) [8830][2] initial start wait reports Running [8820][1] initial start wait reports Running [8810][0] initial start wait reports Running [8850][4] initial start wait reports Running [8840][3] initial start wait reports Running All downstairs are running Apr 14 06:03:34.731 INFO listening, local_addr: 127.0.0.1:9998 Control access at:127.0.0.1:9998 Apr 14 06:03:39.736 INFO accepted connection, remote_addr: 127.0.0.1:56513, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.737 INFO request completed, latency_us: 463, response_code: 200, uri: /state/cid/0, method: GET, req_id: 15432459-25db-4bae-b7a2-c3ec5e0a7fb4, remote_addr: 127.0.0.1:56513, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.752 INFO accepted connection, remote_addr: 127.0.0.1:34720, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.752 INFO request completed, latency_us: 114, response_code: 200, uri: /state/cid/1, method: GET, req_id: a841bb1f-8ee4-4948-889a-34edc8c70a65, remote_addr: 127.0.0.1:34720, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.765 INFO accepted connection, remote_addr: 127.0.0.1:42917, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.765 INFO request completed, latency_us: 105, response_code: 200, uri: /state/cid/2, method: GET, req_id: 8a472835-e2cc-439a-baf3-eb3a23f391bc, remote_addr: 127.0.0.1:42917, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.778 INFO accepted connection, remote_addr: 127.0.0.1:56013, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.779 INFO request completed, latency_us: 96, response_code: 200, uri: /state/cid/3, method: GET, req_id: 6dd35ef7-e2d6-4329-a4fa-5f6b7f212258, remote_addr: 127.0.0.1:56013, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.791 INFO accepted connection, remote_addr: 127.0.0.1:45122, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.792 INFO request completed, latency_us: 61, response_code: 200, uri: /state/cid/4, method: GET, req_id: 2972844f-1c61-449a-903b-8db8bfce04aa, remote_addr: 127.0.0.1:45122, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.804 INFO accepted connection, remote_addr: 127.0.0.1:36473, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.805 INFO request completed, latency_us: 66, response_code: 200, uri: /state/cid/5, method: GET, req_id: 64250536-6ca2-4c66-b4bd-a436cdbfbba7, remote_addr: 127.0.0.1:36473, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.817 INFO accepted connection, remote_addr: 127.0.0.1:34019, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc DisableRestartAll Apr 14 06:03:39.817 INFO request completed, latency_usdisable restart on all: 6 : 72, response_code: 204, uri: /disablerestart/all, method: POST, req_id: bcc2757a-7927-43e6-8e07-7d004a251a6b, remote_addr: 127.0.0.1[8810] Disable keep_running :34019, local_addr: 127.[8830] Disable keep_running 0.0.1:9998 [8820] Disable keep_running [8850] Disable keep_running [8860] Disable keep_running [8840] Disable keep_running Apr 14 06:03:39.882 INFO accepted connection, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.883 INFO request completed, latency_us: 222, response_code: 200, uri: /regioninfo, method: GET, req_id: df346072-07ff-4d26-981d-ed96eb8907d0, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.885 INFO request completed, latency_us: 36, response_code: 200, uri: /regioncount, method: GET, req_id: d13203f7-0c78-49bf-bc1a-3bacfe29fbf3, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.885 INFO request completed, latency_us: 57, response_code: 200, uri: /port/cid/0, method: GET, req_id: 7aeb4ac5-605f-44ce-8ff6-b6db91e2d559, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.885 INFO request completed, latency_us: 50, response_code: 200, uri: /port/cid/1, method: GET, req_id: 16af3be7-3af4-4f58-a82a-deb7de2a440c, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.886 INFO request completed, latency_us: 28, response_code: 200, uri: /port/cid/2, method: GET, req_id: 7fb25610-de59-4d20-a779-9ffc0b36c1db, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.890 INFO request completed, latency_us: 50, response_code: 200, uri: /port/cid/3, method: GET, req_id: 6e763551-4267-4626-8513-cfc45e7b04bf, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.891 INFO request completed, latency_us: 25, response_code: 200, uri: /port/cid/4, method: GET, req_id: 07cb6a69-6101-4060-a2c2-c4215427fded, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:39.891 INFO request completed, latency_us: 22, response_code: 200, uri: /port/cid/5, method: GET, req_id: 5de3b8ac-5ce2-4fc7-86af-ba43b16fba0d, remote_addr: 127.0.0.1:54482, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.950 INFO accepted connection, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.951 INFO request completed, latency_us: 197, response_code: 200, uri: /regioninfo, method: GET, req_id: 3d3666ec-ed20-4b47-9857-c460c17048ee, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.952 INFO request completed, latency_us: 52, response_code: 200, uri: /regioncount, method: GET, req_id: 5eacb588-b2c9-4318-baf6-234927444f40, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.952 INFO request completed, latency_us: 83, response_code: 200, uri: /port/cid/0, method: GET, req_id: f7d7e2c3-40e3-4975-8383-1bd01721d2d3, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.952 INFO request completed, latency_us: 47, response_code: 200, uri: /port/cid/1, method: GET, req_id: d6d536ee-2129-42b8-9e42-485ca5abff62, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.952 INFO request completed, latency_us: 45, response_code: 200, uri: /port/cid/2, method: GET, req_id: 95a29b35-f0bf-4e15-9682-e6ceb8b1e9e9, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.954 INFO request completed, latency_us: 67, response_code: 200, uri: /port/cid/3, method: GET, req_id: efe420e1-7488-49c7-9a0c-e44c244f70d2, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.954 INFO request completed, latency_us: 48, response_code: 200, uri: /port/cid/4, method: GET, req_id: 8eac871d-f377-413d-af25-51a5c2c70c2e, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:48.955 INFO request completed, latency_us: 33, response_code: 200, uri: /port/cid/5, method: GET, req_id: afaa8065-32cb-4d43-849c-e0ec59c5038f, remote_addr: 127.0.0.1:59161, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.261 INFO accepted connection, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.262 INFO request completed, latency_us: 201, response_code: 200, uri: /regioninfo, method: GET, req_id: 514ceecc-b32d-4a92-9903-9806bb8df2f0, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.263 INFO request completed, latency_us: 70, response_code: 200, uri: /regioncount, method: GET, req_id: 16917699-8862-4e4f-962d-317d3885c91e, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.263 INFO request completed, latency_us: 90, response_code: 200, uri: /port/cid/0, method: GET, req_id: 6cd5748b-8f51-49b3-92e5-3e71c40082bb, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.264 INFO request completed, latency_us: 65, response_code: 200, uri: /port/cid/1, method: GET, req_id: 5bd19f79-2446-4131-b452-de534a31364e, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.264 INFO request completed, latency_us: 69, response_code: 200, uri: /port/cid/2, method: GET, req_id: b054855d-4e89-409b-9d16-4e0165287a18, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.266 INFO request completed, latency_us: 67, response_code: 200, uri: /port/cid/3, method: GET, req_id: 7468f7c1-e043-4200-9a31-3b62254c41eb, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.266 INFO request completed, latency_us: 35, response_code: 200, uri: /port/cid/4, method: GET, req_id: 0c5ec02a-05fb-4d30-8eeb-f34f9bdf8734, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:03:58.267 INFO request completed, latency_us: 62, response_code: 200, uri: /port/cid/5, method: GET, req_id: 7d46d152-2d44-4ba4-a7f6-5ad3c3ea8de4, remote_addr: 127.0.0.1:49420, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.679 INFO accepted connection, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.680 INFO request completed, latency_us: 185, response_code: 200, uri: /regioninfo, method: GET, req_id: 2fb877df-cf26-4084-b3af-a07919564f40, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.681 INFO request completed, latency_us: 71, response_code: 200, uri: /regioncount, method: GET, req_id: 9650f9f9-be9b-4d35-8a63-494efb2df668, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.681 INFO request completed, latency_us: 62, response_code: 200, uri: /port/cid/0, method: GET, req_id: a363ed4c-de0e-4921-9706-54b52463d46a, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.681 INFO request completed, latency_us: 32, response_code: 200, uri: /port/cid/1, method: GET, req_id: a7429325-6eda-4436-a69a-8679db37cedd, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.682 INFO request completed, latency_us: 30, response_code: 200, uri: /port/cid/2, method: GET, req_id: 4031a552-2dbf-4bd8-bfa8-d70b634627fe, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.683 INFO request completed, latency_us: 47, response_code: 200, uri: /port/cid/3, method: GET, req_id: 843a48ee-1bb3-4b50-b64f-edabe999bc63, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.683 INFO request completed, latency_us: 35, response_code: 200, uri: /port/cid/4, method: GET, req_id: 36f6edf6-0f81-4830-a6ee-37675e9fdff3, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:04:22.684 INFO request completed, latency_us: 30, response_code: 200, uri: /port/cid/5, method: GET, req_id: e160ad12-c7dc-4481-9402-f4bc99825de2, remote_addr: 127.0.0.1:38508, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.712 INFO accepted connection, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.713 INFO request completed, latency_us: 146, response_code: 200, uri: /regioninfo, method: GET, req_id: d8fdfe1d-59bd-45e4-9f94-9c0f29078e3c, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.714 INFO request completed, latency_us: 71, response_code: 200, uri: /regioncount, method: GET, req_id: e8e79f82-98fb-4225-9773-6a3b23bbf38d, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.714 INFO request completed, latency_us: 67, response_code: 200, uri: /port/cid/0, method: GET, req_id: d84b9173-bdf8-4f4e-9730-1ab5a6d295c8, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.714 INFO request completed, latency_us: 36, response_code: 200, uri: /port/cid/1, method: GET, req_id: 324aa9c0-4c36-4ac4-8426-6f912fdc64f1, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.715 INFO request completed, latency_us: 33, response_code: 200, uri: /port/cid/2, method: GET, req_id: 0db22434-b381-4266-a692-08c60cd861d1, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.716 INFO request completed, latency_us: 57, response_code: 200, uri: /port/cid/3, method: GET, req_id: 320b85f0-a87a-421b-8516-4ddb664d1d2d, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.716 INFO request completed, latency_us: 40, response_code: 200, uri: /port/cid/4, method: GET, req_id: 4f944b4d-2c78-4300-a0e6-98adee1a2da0, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:06:53.717 INFO request completed, latency_us: 33, response_code: 200, uri: /port/cid/5, method: GET, req_id: 40ab1723-4e2c-4341-b621-b992b361ba38, remote_addr: 127.0.0.1:41402, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.553 INFO accepted connection, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.553 INFO request completed, latency_us: 154, response_code: 200, uri: /regioninfo, method: GET, req_id: 613f44aa-5d2b-4135-855f-01dd4cec16b4, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.554 INFO request completed, latency_us: 123, response_code: 200, uri: /regioncount, method: GET, req_id: 53997070-0ef9-458b-b26b-ea3ebf1fd545, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.555 INFO request completed, latency_us: 100, response_code: 200, uri: /port/cid/0, method: GET, req_id: a8f0ec39-f8e8-4bde-b45f-b0db35ed019b, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.555 INFO request completed, latency_us: 72, response_code: 200, uri: /port/cid/1, method: GET, req_id: 5b566e96-29a5-4829-9377-c2af6a3ef6fb, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.555 INFO request completed, latency_us: 66, response_code: 200, uri: /port/cid/2, method: GET, req_id: 96d70101-0598-43ae-97d4-1031be673688, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.557 INFO request completed, latency_us: 72, response_code: 200, uri: /port/cid/3, method: GET, req_id: 0506b144-4ad2-4d69-af63-d226ec8a4d7f, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.557 INFO request completed, latency_us: 64, response_code: 200, uri: /port/cid/4, method: GET, req_id: ee1e0a9e-398f-4f31-b93f-5fb501c7c409, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:15.557 INFO request completed, latency_us: 61, response_code: 200, uri: /port/cid/5, method: GET, req_id: 4718cf58-66a3-41f0-8f11-0beb9fd493bd, remote_addr: 127.0.0.1:54448, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.667 INFO accepted connection, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.667 INFO request completed, latency_us: 174, response_code: 200, uri: /regioninfo, method: GET, req_id: 9eaf46e4-83c3-4cd4-b5eb-31a9aade2260, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.668 INFO request completed, latency_us: 52, response_code: 200, uri: /regioncount, method: GET, req_id: c0868fc9-1563-40dd-8c50-cae92d03e8e7, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.668 INFO request completed, latency_us: 81, response_code: 200, uri: /port/cid/0, method: GET, req_id: 65a81d07-9a36-4be3-a368-81e309b5e665, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.669 INFO request completed, latency_us: 35, response_code: 200, uri: /port/cid/1, method: GET, req_id: ec321ddb-a39c-4da6-a23a-dc036103cdf8, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.669 INFO request completed, latency_us: 31, response_code: 200, uri: /port/cid/2, method: GET, req_id: 779de05c-56c5-44f3-8f2c-a2d457882455, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.670 INFO request completed, latency_us: 46, response_code: 200, uri: /port/cid/3, method: GET, req_id: 3f89a3eb-1903-4500-87c4-bcb7edccdfe5, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.670 INFO request completed, latency_us: 31, response_code: 200, uri: /port/cid/4, method: GET, req_id: 7f2b1385-8c7c-45ec-9c1f-79b7b66acb47, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:19.671 INFO request completed, latency_us: 30, response_code: 200, uri: /port/cid/5, method: GET, req_id: 18c68971-d56d-4245-877c-a9554f71c02e, remote_addr: 127.0.0.1:58607, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.768 INFO accepted connection, remote_addr: 127.0.0.1:35959, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc DisableRestartAll disable restart on all: 6 Apr 14 06:07:23.768 INFO request completed, latency_us: 160, response_code: 204, uri: /disablerestart/all, method: POST, req_id: 1d53e328-9e51-4200-932b-08953a21dc66, remote_addr: 127.0.0.1:35959, local_addr: 127.0.0.1:9998 [8810] Disable keep_running [8820] Disable keep_running [8830] Disable keep_running [8850] Disable keep_running [8860] Disable keep_running [8840] Disable keep_running Apr 14 06:07:23.783 INFO accepted connection, remote_addr: 127.0.0.1:48996, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(2) stop 2 Apr 14 06:07:23.783 INFO request completed, latency_us: 110, response_code: 204, uri: /stop/cid/2, method: POST, req_id: ee2c74bf-1012-4765-b4ca-59f5d96910bc, remote_addr: 127.0.0.1:48996, local_addr: 127.0.0.1:9998 [8830] Got stop action so:false kr:false [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit Apr 14 06:07:23.797 INFO accepted connection, remote_addr: 127.0.0.1:43807, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.797 INFO request completed, latency_us: 78, response_code: 200, uri: /state/cid/2, method: GET, req_id: 34636aa0-d903-4b72-b86d-f607b70615f4, remote_addr: 127.0.0.1:43807, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.813 INFO accepted connection, remote_addr: 127.0.0.1:44918, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(2) start 2 Apr 14 06:07:23.813 INFO request completed, latency_us: 68, response_code: 204, uri: /start/cid/2, method: POST, req_id: 5358fb99-2ab0-48b4-93c5-f35af4314d6f, remote_addr: 127.0.0.1:44918, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.848 INFO accepted connection, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.848 INFO request completed, latency_us: 95, response_code: 200, uri: /regioninfo, method: GET, req_id: 8071aa5b-d31f-4b21-bba8-30e0b4b78309, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.849 INFO request completed, latency_us: 32, response_code: 200, uri: /regioncount, method: GET, req_id: 23dac9d3-45d8-422d-b9f3-99310afa71c3, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.849 INFO request completed, latency_us: 47, response_code: 200, uri: /port/cid/0, method: GET, req_id: c44c8141-8ef2-4814-bb58-8bffc83ea506, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.849 INFO request completed, latency_us: 26, response_code: 200, uri: /port/cid/1, method: GET, req_id: d1262aff-d764-4476-8990-55db1255cba4, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.849 INFO request completed, latency_us: 26, response_code: 200, uri: /port/cid/2, method: GET, req_id: 81e6365d-979f-439a-b590-395d36ccdda0, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.851 INFO request completed, latency_us: 59, response_code: 200, uri: /port/cid/3, method: GET, req_id: 2cc2ff80-5541-4251-9fd7-54e44b90b511, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.851 INFO request completed, latency_us: 30, response_code: 200, uri: /port/cid/4, method: GET, req_id: 83c0452d-315f-4c51-be98-441077b2402f, remote_addr: 127.0.0.1:49053, local_addr: 127.0.0.1:9998 Apr 14 06:07:23.851 INFO request completed, latency_us: 32, response_code: 200, uri: /port/cid/5, method: GET, req_id: 632eb6fc-de5a-47ed-94c3-a0281fede58c, remote_addr: 127.0.0.1:49053, 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(1196) [8830][2] reports Running Apr 14 06:07:37.987 INFO accepted connection, remote_addr: 127.0.0.1:48289, local_addr: 127.0.0.1:9998 Main task has work to do, go find it Apr 14 06:07:37.988 INFO request completed, latency_usgot dsc Shutdown :Shutdown 130, response_code: 204, uri: /shutdown, method: POST, req_id: 16c571a3-e250-48b8-8db9-5d2075af33b8, remote_addr: 127.0.0.1:48289, local_addr: 127.0.0.1:9998 Shut it down [8810] Disable keep_running [8810] Got stop action so:false kr:false [8830] Disable keep_running [8830] Got stop action so:false kr:false [8840] Disable keep_running [8840] Got stop action so:false kr:false [8850] Disable keep_running [8850] Got stop action so:false kr:false [8860] Disable keep_running [8860] Got stop action so:false kr:false [8820] Disable keep_running [8820] Got stop action so:false kr:false [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit [8840] Exited with: ExitStatus(unix_wait_status(9)) [8840][3] reports Exit [8850] Exited with: ExitStatus(unix_wait_status(9)) [8860] Exited with: ExitStatus(unix_wait_status(9)) [8850][4] reports Exit [8860][5] reports Exit [8820] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit /var/tmp/bins/dsc create --encrypted --cleanup --region-count 7 --extent-count 400 --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.030473458 Downstairs region 1 created at /var/tmp/test_up-build/8820 in 0.028243704 Downstairs region 2 created at /var/tmp/test_up-build/8830 in 0.027591474 Downstairs region 3 created at /var/tmp/test_up-build/8840 in 0.026329605 Downstairs region 4 created at /var/tmp/test_up-build/8850 in 0.025786012 Downstairs region 5 created at /var/tmp/test_up-build/8860 in 0.02517478 Downstairs region 6 created at /var/tmp/test_up-build/8870 in 0.032605845 Created 7 regions /var/tmp/bins/dsc start --region-count 7 --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: 400 }) start ds: 8810 start access at:127.0.0.1:9998 start ds: 8820 start ds: 8830 start ds: 8840 start ds: 8850 start ds: 8860 Starting downstairs at port 8810 start ds: 8870 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" Starting downstairs at port 8830 [8810][0] initial start wait reports Starting [8820][1] initial start wait reports Starting Starting downstairs at port 8840 Make output file at "/tmp/test_up-build/dsc/downstairs-8830.txt" [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 Starting downstairs at port 8850 Make output file at "/tmp/test_up-build/dsc/downstairs-8850.txt" Starting downstairs at port 8860 Make output file at "/tmp/test_up-build/dsc/downstairs-8860.txt" Starting downstairs at port 8870 Make output file at "/tmp/test_up-build/dsc/downstairs-8870.txt" [8850][4] initial start wait reports Starting [8860][5] initial start wait reports Starting [8870][6] initial start wait reports Starting Downstairs /var/tmp/test_up-build/8860 port 8860 PID:Some(1214) Downstairs /var/tmp/test_up-build/8840 port 8840 PID:Some(1216) Downstairs /var/tmp/test_up-build/8830 port 8830 PID:Some(1218) Downstairs /var/tmp/test_up-build/8870 port 8870 PID:Some(1213) Downstairs /var/tmp/test_up-build/8810 port 8810 PID:Some(1217) Downstairs /var/tmp/test_up-build/8820 port 8820 PID:Some(1215) Downstairs /var/tmp/test_up-build/8850 port 8850 PID:Some(1219) Control access at:127.0.0.1:9998 Apr 14 06:07:43.208 INFO listening, local_addr: 127.0.0.1:9998 [8860][5] initial start wait reports Running [8840][3] initial start wait reports Running [8830][2] initial start wait reports Running [8870][6] initial start wait reports Running [8810][0] initial start wait reports Running [8820][1] initial start wait reports Running [8850][4] initial start wait reports Running All downstairs are running Apr 14 06:07:48.220 INFO accepted connection, remote_addr: 127.0.0.1:40304, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.221 INFO request completed, latency_us: 312, response_code: 200, uri: /state/cid/0, method: GET, req_id: 40be7539-e2a0-40c1-8c5b-bce90eb382b0, remote_addr: 127.0.0.1:40304, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.236 INFO accepted connection, remote_addr: 127.0.0.1:51696, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.236 INFO request completed, latency_us: 66, response_code: 200, uri: /state/cid/1, method: GET, req_id: 01dc7b10-5944-43f3-b118-375d9929e1ef, remote_addr: 127.0.0.1:51696, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.249 INFO accepted connection, remote_addr: 127.0.0.1:38183, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.250 INFO request completed, latency_us: 62, response_code: 200, uri: /state/cid/2, method: GET, req_id: 66c4995c-f9dd-4720-8ed5-7555117025f8, remote_addr: 127.0.0.1:38183, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.263 INFO accepted connection, remote_addr: 127.0.0.1:58060, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.263 INFO request completed, latency_us: 66, response_code: 200, uri: /state/cid/3, method: GET, req_id: 92a9f1f6-2546-4c09-8978-424f011997dc, remote_addr: 127.0.0.1:58060, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.277 INFO accepted connection, remote_addr: 127.0.0.1:50515, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.277 INFO request completed, latency_us: 61, response_code: 200, uri: /state/cid/4, method: GET, req_id: 113a35e3-fca4-428c-a9a5-382a113bf966, remote_addr: 127.0.0.1:50515, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.290 INFO accepted connection, remote_addr: 127.0.0.1:47018, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.290 INFO request completed, latency_us: 63, response_code: 200, uri: /state/cid/5, method: GET, req_id: f2a664ea-9a47-4c1f-8b5a-789e7aa287df, remote_addr: 127.0.0.1:47018, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.303 INFO accepted connection, remote_addr: 127.0.0.1:33771, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.303 INFO request completed, latency_us: 66, response_code: 200, uri: /state/cid/6, method: GET, req_id: 9a13b020-a206-4092-9a1e-071d6e1a2aaf, remote_addr: 127.0.0.1:33771, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.316 INFO accepted connection, remote_addr: 127.0.0.1:45069, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.316 INFO request completed, latency_us: 82, response_code: 200, uri: /port/cid/6, method: GET, req_id: fe4671cc-b773-460a-a4b3-59764e34d338, remote_addr: 127.0.0.1:45069, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.336 INFO accepted connection, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.336 INFO request completed, latency_us: 99, response_code: 200, uri: /regioninfo, method: GET, req_id: aba321f5-644a-4e17-a3dd-fdd4a7dc5a91, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.337 INFO request completed, latency_us: 67, response_code: 200, uri: /regioncount, method: GET, req_id: f34ceee2-a709-4bb9-acd6-258f01111cd5, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.338 INFO request completed, latency_us: 69, response_code: 200, uri: /port/cid/0, method: GET, req_id: a5fceef2-6010-4ea6-88ca-139fbabe0c53, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.338 INFO request completed, latency_us: 30, response_code: 200, uri: /port/cid/1, method: GET, req_id: 182ba144-a9d3-4162-8d11-3a50c010ab3c, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.338 INFO request completed, latency_us: 38, response_code: 200, uri: /port/cid/2, method: GET, req_id: ba5a6670-1d2b-459d-81f9-1a558015395e, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.339 INFO request completed, latency_us: 45, response_code: 200, uri: /port/cid/3, method: GET, req_id: 492d91e5-9077-4eef-b970-843b097bf70a, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.339 INFO request completed, latency_us: 26, response_code: 200, uri: /port/cid/4, method: GET, req_id: 95ef04d2-6acb-400e-bd21-8b497d2e0de1, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.339 INFO request completed, latency_us: 22, response_code: 200, uri: /port/cid/5, method: GET, req_id: be06f13c-689d-4333-ab4c-9c0758711c16, remote_addr: 127.0.0.1:50265, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.361 INFO accepted connection, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.362 INFO request completed, latency_us: 131, response_code: 200, uri: /regioncount, method: GET, req_id: 02435525-5a7d-4da4-b35b-8c988c92991b, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Apr 14 06:07:48.750 INFO request completed, latency_us: 238, response_code: 204, uri[8810] Got stop action so:false kr:false : /stop/cid/0, method: POST, req_id: 012b44b6-8504-40ae-af5a-ed728d5effed, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:07:48.751 INFO request completed, latency_us: 57, response_code: 200, uri: /state/cid/0, method: GET, req_id: 2fa0235c-b064-48ef-aafd-54ad48c10add, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Apr 14 06:07:52.753 INFO request completed, latency_us: 289, response_code: 200, uri: /state/cid/0, method: GET, req_id: 1ff18f1c-2736-45b8-9be6-75a03a83f856, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Apr 14 06:07:53.144 INFO request completed, latency_us: 240, response_code: 204, uri: /start/cid/0, method: POST, req_id: c40df9cf-da90-4491-8ecc-340f7079b0b3, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:07:53.145 INFO request completed, latency_us: 85, response_code: 200, uri: /state/cid/0, method: GET, req_id: fc861914-9c05-4754-adfe-3392f195269a, remote_addr: 127.0.0.1:47485, 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(1230) [8810][0] reports Running Apr 14 06:07:57.146 INFO request completed, latency_us: 237, response_code: 200, uri: /state/cid/0, method: GET, req_id: 0dfc2ebf-8bbd-412e-9792-91a849c9893f, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Apr 14 06:08:03.540 [8810] Got stop action so:false kr:false INFO request completed, latency_us: 260, response_code: 204, uri: /stop/cid/0, method: POST, req_id: 76f80fb7-21fc-4004-8f38-6efdb72d0796, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:03.541 INFO request completed, latency_us: 149, response_code: 200, uri: /state/cid/0, method: GET, req_id: a703bffe-165f-4a56-b8a3-7f5348c9df8e, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Apr 14 06:08:07.542 INFO request completed, latency_us: 255, response_code: 200, uri: /state/cid/0, method: GET, req_id: fa9d60f4-16ec-4283-b56c-ca629489374d, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Apr 14 06:08:07.942 INFO request completed, latency_us: 226, response_code: 204, uri: /start/cid/0, method: POST, req_id: 6e1741aa-b197-4ca5-81cd-909bced84a44, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:07.943 INFO request completed, latency_us: 146, response_code: 200, uri: /state/cid/0, method: GET, req_id: 47e66acc-f200-43d9-829a-ad02bb793d8b, remote_addr: 127.0.0.1:47485, 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(1231) [8810][0] reports Running Apr 14 06:08:11.944 INFO request completed, latency_us: 247, response_code: 200, uri: /state/cid/0, method: GET, req_id: 86003f52-3550-4e3b-ae6a-545394e2e09a, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Apr 14 06:08:17.338 INFO request completed[8810] Got stop action so:false kr:false , latency_us: 223, response_code: 204, uri: /stop/cid/0, method: POST, req_id: d5789fc3-2884-43c9-a7ca-7db81c0173b1, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:17.339 INFO request completed, latency_us: 142, response_code: 200, uri: /state/cid/0, method: GET, req_id: edfa61c5-7238-47e4-acff-51e2c5bc7b64, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Apr 14 06:08:21.341 INFO request completed, latency_us: 269, response_code: 200, uri: /state/cid/0, method: GET, req_id: 7ea4b390-88db-41bb-b821-8b95386c3746, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Apr 14 06:08:21.745 INFO request completed, latency_us: 222, response_code: 204, uri: /start/cid/0, method: POST, req_id: 4e6f8a98-c3e3-4ac1-89ca-96a2e73e955e, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:21.746 INFO request completed, latency_us: 46, response_code: 200, uri: /state/cid/0, method: GET, req_id: cc813f8c-a049-4502-890a-02cdd99d7108, remote_addr: 127.0.0.1:47485, 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(1232) [8810][0] reports Running Apr 14 06:08:25.748 INFO request completed, latency_us: 277, response_code: 200, uri: /state/cid/0, method: GET, req_id: 23d1ca24-8130-4b47-9340-5b5deef4fcad, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Apr 14 06:08:30.139 INFO request completed, [8810] Got stop action so:false kr:false latency_us: 223, response_code: 204, uri: /stop/cid/0, method: POST, req_id: 103745c0-cd69-4ba2-949f-9baf1f058e73, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:30.140 INFO request completed, latency_us: 58, response_code: 200, uri: /state/cid/0, method: GET, req_id: ccb21f2d-525c-4e5d-bb37-771befc13e00, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Apr 14 06:08:34.142 INFO request completed, latency_us: 291, response_code: 200, uri: /state/cid/0, method: GET, req_id: 77cf3a7a-a42c-4197-9691-88831e8d1c5c, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Apr 14 06:08:34.545 INFO request completed, latency_us: 226, response_code: 204, uri: /start/cid/0, method: POST, req_id: ad0b75db-1811-402f-bc5a-8af8d8c18f21, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:34.545 INFO request completed, latency_us: 46, response_code: 200, uri: /state/cid/0, method: GET, req_id: 270e4ae5-24fc-4948-8794-e7d3a531854a, remote_addr: 127.0.0.1:47485, 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(1233) [8810][0] reports Running Apr 14 06:08:38.548 INFO request completed, latency_us: 260, response_code: 200, uri: /state/cid/0, method: GET, req_id: 91839c46-32b0-4b50-9d34-3fe82dfa1005, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 [8810] Got stop action so:false kr:false Apr 14 06:08:41.937 INFO request completed, latency_us: 359, response_code: 204, uri: /stop/cid/0, method: POST, req_id: 39989979-0b0d-4603-8551-70cc3ce3ad23, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:41.937 INFO request completed, latency_us: 141, response_code: 200, uri: /state/cid/0, method: GET, req_id: 5c6c4f83-0f45-4e43-b598-9866a84cf6bc, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Apr 14 06:08:45.939 INFO request completed, latency_us: 275, response_code: 200, uri: /state/cid/0, method: GET, req_id: d9e5eac2-80c5-446c-a98d-d58e8eac8f7f, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Apr 14 06:08:46.344 INFO request completed, latency_us: 224, response_code: 204, uri: /start/cid/0, method: POST, req_id: af2c8173-1e7a-4dc0-87dc-05f9a5362cc3, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:46.344 INFO request completed, latency_us: 53, response_code: 200, uri: /state/cid/0, method: GET, req_id: 10b32c7d-6538-4b7b-bb64-b0013f7d4068, remote_addr: 127.0.0.1:47485, 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(1234) [8810][0] reports Running Apr 14 06:08:50.346 INFO request completed, latency_us: 282, response_code: 200, uri: /state/cid/0, method: GET, req_id: 5caadb22-e02f-4d6c-8c80-7ca63deb4b8f, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Apr 14 06:08:52.738 INFO request completed, [8810] Got stop action so:false kr:false latency_us: 219, response_code: 204, uri: /stop/cid/0, method: POST, req_id: 855640c8-60b8-47de-80cc-f5eeddeb1b71, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:52.739 INFO request completed, latency_us: 82, response_code: 200, uri: /state/cid/0, method: GET, req_id: 148e309a-271a-488f-8b31-2038c926bebd, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Apr 14 06:08:56.741 INFO request completed, latency_us: 293, response_code: 200, uri: /state/cid/0, method: GET, req_id: 4da82512-77a1-417f-81fa-8fbb0f5d7633, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Apr 14 06:08:57.145 INFO request completed, latency_us: 222, response_code: 204, uri: /start/cid/0, method: POST, req_id: c7bc74d5-b1b1-4175-933e-7aea6703b2de, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:08:57.145 INFO request completed, latency_us: 50, response_code: 200, uri: /state/cid/0, method: GET, req_id: c73bedbf-e2f0-4da2-846e-db015f1dd1f6, remote_addr: 127.0.0.1:47485, 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(1235) [8810][0] reports Running Apr 14 06:09:01.148 INFO request completed, latency_us: 282, response_code: 200, uri: /state/cid/0, method: GET, req_id: b94c61fc-5104-4ad6-afba-920df17ff970, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(1) stop 1 [8820] Got stop action so:false kr:false Apr 14 06:09:28.626 INFO request completed, latency_us: 224, response_code: 204, uri: /stop/cid/1, method: POST, req_id: 1005b0f1-0d61-41c3-b779-572998c6731f, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:09:28.626 INFO request completed, latency_us: 91, response_code: 200, uri: /state/cid/1, method: GET, req_id: 43b8554c-7d8f-45aa-881d-aadedc545ad7, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8820] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit Apr 14 06:09:32.629 INFO request completed, latency_us: 268, response_code: 200, uri: /state/cid/1, method: GET, req_id: efb28105-eb5a-4175-b5f5-466b4b14ea20, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(1) start 1 Apr 14 06:09:33.030 INFO request completed, latency_us: 221, response_code: 204, uri: /start/cid/1, method: POST, req_id: f9610654-a5bf-4659-8230-a5e9b9331489, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:09:33.030 INFO request completed, latency_us: 64, response_code: 200, uri: /state/cid/1, method: GET, req_id: ac84c061-dac6-40cb-9187-3b57c39a3260, remote_addr: 127.0.0.1:47485, 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(1236) [8820][1] reports Running Apr 14 06:09:37.033 INFO request completed, latency_us: 241, response_code: 200, uri: /state/cid/1, method: GET, req_id: f6ec624e-a790-4dcb-a529-cb4bae741377, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(2) stop 2 Apr 14 06:10:04.602 INFO request completed, [8830] Got stop action so:false kr:false latency_us: 218, response_code: 204, uri: /stop/cid/2, method: POST, req_id: 3c6e27f8-5e94-4832-ab7b-bb2fec278f17, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:10:04.603 INFO request completed, latency_us: 80, response_code: 200, uri: /state/cid/2, method: GET, req_id: 67739c9c-6511-4f90-a54d-6196002448f1, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit Apr 14 06:10:08.604 INFO request completed, latency_us: 295, response_code: 200, uri: /state/cid/2, method: GET, req_id: e4ade5bb-db02-413f-8dc7-927b0b26c752, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(2) start 2 Apr 14 06:10:09.006 INFO request completed, latency_us: 220, response_code: 204, uri: /start/cid/2, method: POST, req_id: 7b2e5c83-e63a-4248-ab2a-182d89d9d0b1, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:10:09.007 INFO request completed, latency_us: 81, response_code: 200, uri: /state/cid/2, method: GET, req_id: 2d940bdd-9da1-460a-9b1a-d9e4b97db004, remote_addr: 127.0.0.1:47485, 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(1237) [8830][2] reports Running Apr 14 06:10:13.009 INFO request completed, latency_us: 244, response_code: 200, uri: /state/cid/2, method: GET, req_id: e0922449-0c49-4874-b700-99a58e268059, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(3) stop 3 [8840] Got stop action so:false kr:false Apr 14 06:10:40.822 INFO request completed, latency_us: 221, response_code: 204, uri: /stop/cid/3, method: POST, req_id: 89eeea24-d83c-4714-83af-445dae46ac76, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:10:40.823 INFO request completed, latency_us: 59, response_code: 200, uri: /state/cid/3, method: GET, req_id: 9734c569-8d87-4d3e-826d-aa623bd0c933, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 [8840] Exited with: ExitStatus(unix_wait_status(9)) [8840][3] reports Exit Apr 14 06:10:44.825 INFO request completed, latency_us: 296, response_code: 200, uri: /state/cid/3, method: GET, req_id: 097949d8-5623-4bcc-8a9a-04bc8a8db15d, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(3) start 3 Apr 14 06:10:45.235 INFO request completed, latency_us: 224, response_code: 204, uri: /start/cid/3, method: POST, req_id: 817843d5-a7db-4eb8-90f9-e670c3092707, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:10:45.235 INFO request completed, latency_us: 85, response_code: 200, uri: /state/cid/3, method: GET, req_id: 19243230-9e4f-43b2-8f3f-bf590d2d4885, remote_addr: 127.0.0.1:47485, 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(1238) [8840][3] reports Running Apr 14 06:10:49.238 INFO request completed, latency_us: 245, response_code: 200, uri: /state/cid/3, method: GET, req_id: cad3ff5a-1571-47f8-8421-77ab6fff2a7d, remote_addr: 127.0.0.1:47485, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.904 INFO accepted connection, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.904 INFO request completed, latency_us: 149, response_code: 200, uri: /regioninfo, method: GET, req_id: 4f00a436-57f8-4a20-848b-dba9d79128a0, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.905 INFO request completed, latency_us: 56, response_code: 200, uri: /regioncount, method: GET, req_id: d9c76398-5abb-4616-b9c2-a9abf08a94e8, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.905 INFO request completed, latency_us: 58, response_code: 200, uri: /port/cid/0, method: GET, req_id: eb2f5351-1498-4f77-87bd-59443a728b57, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.906 INFO request completed, latency_us: 34, response_code: 200, uri: /port/cid/1, method: GET, req_id: c8f152d5-d7cb-472e-880c-f4a74a545af8, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.906 INFO request completed, latency_us: 28, response_code: 200, uri: /port/cid/2, method: GET, req_id: 5d3e6370-12aa-43bb-9f00-e5a4e6f0a62d, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.907 INFO request completed, latency_us: 46, response_code: 200, uri: /port/cid/3, method: GET, req_id: db473e88-ee86-480d-944c-3b1e2a53d752, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.908 INFO request completed, latency_us: 74, response_code: 200, uri: /port/cid/4, method: GET, req_id: 53c3723e-d93d-4afd-9ad4-6eae96f24f5a, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:16.908 INFO request completed, latency_us: 63, response_code: 200, uri: /port/cid/5, method: GET, req_id: 81c7120c-60d4-457d-91d9-cdbf12d325be, remote_addr: 127.0.0.1:56540, local_addr: 127.0.0.1:9998 Apr 14 06:11:17.108 INFO accepted connection, remote_addr: 127.0.0.1:38793, local_addr: 127.0.0.1:9998 Apr 14 06:11:17.108 INFO request completed, latency_us: 133, response_code: 200, uri: /regioncount, method: GET, req_id: 18f11998-9603-4551-9128-064624ecfa39, remote_addr: 127.0.0.1:38793, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Stop(0) stop 0 Apr 14 06:11:22.786 INFO request completed, [8810] Got stop action so:false kr:false latency_us: 225, response_code: 204, uri: /stop/cid/0, method: POST, req_id: d24eef77-518f-4812-86f6-60c1006df8b6, remote_addr: 127.0.0.1:38793, local_addr: 127.0.0.1:9998 Apr 14 06:11:22.786 INFO request completed, latency_us: 55, response_code: 200, uri: /state/cid/0, method: GET, req_id: 7adb7f9d-d14d-422b-b9a6-fe1dbc60b2e7, remote_addr: 127.0.0.1:38793, local_addr: 127.0.0.1:9998 [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit Apr 14 06:11:26.788 INFO request completed, latency_us: 268, response_code: 200, uri: /state/cid/0, method: GET, req_id: 841d35a9-d8c3-415d-813e-d56f203db79d, remote_addr: 127.0.0.1:38793, local_addr: 127.0.0.1:9998 Apr 14 06:12:04.039 INFO accepted connection, remote_addr: 127.0.0.1:42238, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(0) start 0 Apr 14 06:12:04.040 INFO request completed, latency_us: 168, response_code: 204, uri: /start/cid/0, method: POST, req_id: 5d906f02-227b-4f91-8906-1309b516a893, remote_addr: 127.0.0.1:42238, 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(1240) [8810][0] reports Running Main task has work to do, go find it got dsc Stop(1) stop 1 Apr 14 06:12:08.438 [8820] Got stop action so:false kr:false INFO request completed, latency_us: 230, response_code: 204, uri: /stop/cid/1, method: POST, req_id: 41ac54d3-5b66-4b74-9a69-ac900bc37085, remote_addr: 127.0.0.1:42238, local_addr: 127.0.0.1:9998 Apr 14 06:12:08.438 INFO request completed, latency_us: 54, response_code: 200, uri: /state/cid/1, method: GET, req_id: 435ddaa7-9285-476f-83e8-1d7d471969e7, remote_addr: 127.0.0.1:42238, local_addr: 127.0.0.1:9998 [8820] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit Apr 14 06:12:12.441 INFO request completed, latency_us: 287, response_code: 200, uri: /state/cid/1, method: GET, req_id: 9591f204-39d2-4e5b-ac0a-f4eeea4d373b, remote_addr: 127.0.0.1:42238, local_addr: 127.0.0.1:9998 Apr 14 06:12:49.717 INFO accepted connection, remote_addr: 127.0.0.1:55439, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(1) start 1 Apr 14 06:12:49.717 INFO request completed, latency_us: 174, response_code: 204, uri: /start/cid/1, method: POST, req_id: 2c9a4956-240b-42eb-a4eb-f641612c8800, remote_addr: 127.0.0.1:55439, 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(1241) [8820][1] reports Running Main task has work to do, go find it got dsc Stop(2) stop 2 [8830] Got stop action so:false kr:false Apr 14 06:12:54.120 INFO request completed, latency_us: 223, response_code: 204, uri: /stop/cid/2, method: POST, req_id: 8fd6a945-5c34-4443-91ec-04c645bf0a7e, remote_addr: 127.0.0.1:55439, local_addr: 127.0.0.1:9998 Apr 14 06:12:54.120 INFO request completed, latency_us: 59, response_code: 200, uri: /state/cid/2, method: GET, req_id: 7c8691aa-68e4-4886-953c-544cd1516788, remote_addr: 127.0.0.1:55439, local_addr: 127.0.0.1:9998 [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit Apr 14 06:12:58.123 INFO request completed, latency_us: 243, response_code: 200, uri: /state/cid/2, method: GET, req_id: 63aa7eca-9fc8-431a-95af-9446930ae08a, remote_addr: 127.0.0.1:55439, local_addr: 127.0.0.1:9998 Apr 14 06:13:35.402 INFO accepted connection, remote_addr: 127.0.0.1:56031, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(2) start 2 Apr 14 06:13:35.403 INFO request completed, latency_us: 185, response_code: 204, uri: /start/cid/2, method: POST, req_id: 161c9fbc-9768-4d81-86e6-555dd12e62d6, remote_addr: 127.0.0.1:56031, 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 Main task has work to do, go find it got dsc Stop(3) stop 3 Apr 14 06:13:39.814 INFO[8840] Got stop action so:false kr:false request completed, latency_us: 223, response_code: 204, uri: /stop/cid/3, method: POST, req_id: fc884d36-c5ee-4907-b469-c0b140305aa9, remote_addr: 127.0.0.1:56031, local_addr: 127.0.0.1:9998 Apr 14 06:13:39.814 INFO request completed, latency_us: 147, response_code: 200, uri: /state/cid/3, method: GET, req_id: 5e9c1469-5c85-4f6e-b87b-f6104585a854, remote_addr: 127.0.0.1:56031, local_addr: 127.0.0.1:9998 [8840] Exited with: ExitStatus(unix_wait_status(9)) [8840][3] reports Exit Apr 14 06:13:43.816 INFO request completed, latency_us: 248, response_code: 200, uri: /state/cid/3, method: GET, req_id: 954470c0-58d6-4e36-95f1-ce96b8af3749, remote_addr: 127.0.0.1:56031, local_addr: 127.0.0.1:9998 Apr 14 06:14:21.086 INFO accepted connection, remote_addr: 127.0.0.1:54619, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(3) Apr 14 06:14:21.086 INFO request completedstart 3 , latency_us: 168, response_code: 204, uri: /start/cid/3, method: POST, req_id: 5a2e8311-ad22-4bd1-a960-33e94d7b47df, remote_addr: 127.0.0.1:54619, 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(1243) [8840][3] reports Running Main task has work to do, go find it got dsc Stop(4) stop 4 [8850] Got stop action so:false kr:false Apr 14 06:14:25.633 INFO request completed, latency_us: 224, response_code: 204, uri: /stop/cid/4, method: POST, req_id: 3e443032-3e1b-4996-95aa-c4c06fddb041, remote_addr: 127.0.0.1:54619, local_addr: 127.0.0.1:9998 Apr 14 06:14:25.633 INFO request completed, latency_us: 85, response_code: 200, uri: /state/cid/4, method: GET, req_id: 13d43e2b-95cc-469e-b909-d522dbe04854, remote_addr: 127.0.0.1:54619, local_addr: 127.0.0.1:9998 [8850] Exited with: ExitStatus(unix_wait_status(9)) [8850][4] reports Exit Apr 14 06:14:29.636 INFO request completed, latency_us: 230, response_code: 200, uri: /state/cid/4, method: GET, req_id: 33968db3-2839-4034-9f40-b491289a5736, remote_addr: 127.0.0.1:54619, local_addr: 127.0.0.1:9998 Apr 14 06:15:06.933 INFO accepted connection, remote_addr: 127.0.0.1:44203, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Start(4) start 4 Apr 14 06:15:06.933 INFO request completed, latency_us: 176, response_code: 204, uri: /start/cid/4, method: POST, req_id: 7f7759c3-ef63-4e33-9b2b-c4607a6834f8, remote_addr: 127.0.0.1:44203, local_addr: 127.0.0.1:9998 [8850] got start action [8850] I am going to restart Starting downstairs at port 8850 Make output file at "/tmp/test_up-build/dsc/downstairs-8850.txt" [8850][4] reports Starting Downstairs /var/tmp/test_up-build/8850 port 8850 PID:Some(1244) [8850][4] reports Running Apr 14 06:15:10.982 INFO accepted connection, remote_addr: 127.0.0.1:42554, local_addr: 127.0.0.1:9998 Main task has work to do, go find it got dsc Shutdown Shutdown Shut it down [8810] Disable keep_running Apr 14 06:15:10.982 INFO request completed, latency_us[8810] Got stop action so:false kr:false : [8820] Disable keep_running 126, response_code: 204, uri: /shutdown, method: POST, req_id: d4fa1b7d-ada6-4381-afe9-65936e87188a, remote_addr: 127.0.0.1:42554, local_addr: 127.0.0.1:9998[8840] Disable keep_running [8820] Got stop action so:false kr:false [8840] Got stop action so:false kr:false [8860] Disable keep_running [8860] Got stop action so:false kr:false [8850] Disable keep_running [8850] Got stop action so:false kr:false [8870] Disable keep_running [8870] Got stop action so:false kr:false [8830] Disable keep_running [8830] Got stop action so:false kr:false [8850] Exited with: ExitStatus(unix_wait_status(9)) [8850][4] reports Exit [8840] Exited with: ExitStatus(unix_wait_status(9)) [8840][3] reports Exit [8830] Exited with: ExitStatus(unix_wait_status(9)) [8830][2] reports Exit [8810] Exited with: ExitStatus(unix_wait_status(9)) [8810][0] reports Exit [8860] Exited with: ExitStatus(unix_wait_status(9)) [8860][5] reports Exit [8820] Exited with: ExitStatus(unix_wait_status(9)) [8820][1] reports Exit [8870] Exited with: ExitStatus(unix_wait_status(9)) [8870][6] reports Exit