Nov 17 22:54:09.803 INFO testing silk-0.3.3 against master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c for pr-55982 Nov 17 22:54:09.804 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-3/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/pr-55982/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +6b9b97bd9b704f85f0184f7a213cc4d62bd9654c-alt build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"` Nov 17 22:54:10.196 INFO [stdout] 93fb3ef30304155aab40691a60e7a1c41a0abd8d8d7cd2a3da8b5765c88a9b11 Nov 17 22:54:10.201 INFO running `"docker" "start" "-a" "93fb3ef30304155aab40691a60e7a1c41a0abd8d8d7cd2a3da8b5765c88a9b11"` Nov 17 22:54:11.563 INFO [stderr] usermod: no changes Nov 17 22:54:11.759 INFO [stderr] Compiling generic-array v0.9.0 Nov 17 22:54:11.771 INFO [stderr] Compiling ring v0.12.1 Nov 17 22:54:12.823 INFO [stderr] Compiling digest v0.7.6 Nov 17 22:54:13.607 INFO [stderr] Compiling sha2 v0.7.1 Nov 17 22:54:21.695 INFO [stderr] Compiling silk v0.3.3 (/source) Nov 17 22:54:39.173 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 27.58s Nov 17 22:54:39.188 INFO [stderr] su: No module specific data is present Nov 17 22:54:39.481 INFO running `"docker" "inspect" "93fb3ef30304155aab40691a60e7a1c41a0abd8d8d7cd2a3da8b5765c88a9b11"` Nov 17 22:54:39.590 INFO running `"docker" "rm" "-f" "93fb3ef30304155aab40691a60e7a1c41a0abd8d8d7cd2a3da8b5765c88a9b11"` Nov 17 22:54:39.699 INFO [stdout] 93fb3ef30304155aab40691a60e7a1c41a0abd8d8d7cd2a3da8b5765c88a9b11 Nov 17 22:54:39.706 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-3/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/pr-55982/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +6b9b97bd9b704f85f0184f7a213cc4d62bd9654c-alt test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"` Nov 17 22:54:39.872 INFO [stdout] 3884266e386410316be764a4d8a0d64fdce59fab4c68e33caf3035143771e629 Nov 17 22:54:39.874 INFO running `"docker" "start" "-a" "3884266e386410316be764a4d8a0d64fdce59fab4c68e33caf3035143771e629"` Nov 17 22:54:40.292 INFO [stderr] usermod: no changes Nov 17 22:54:40.400 INFO [stderr] Compiling silk v0.3.3 (/source) Nov 17 22:54:55.734 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 15.42s Nov 17 22:54:55.755 INFO [stderr] su: No module specific data is present Nov 17 22:54:56.165 INFO running `"docker" "inspect" "3884266e386410316be764a4d8a0d64fdce59fab4c68e33caf3035143771e629"` Nov 17 22:54:56.279 INFO running `"docker" "rm" "-f" "3884266e386410316be764a4d8a0d64fdce59fab4c68e33caf3035143771e629"` Nov 17 22:54:56.383 INFO [stdout] 3884266e386410316be764a4d8a0d64fdce59fab4c68e33caf3035143771e629 Nov 17 22:54:56.384 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-3/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/pr-55982/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +6b9b97bd9b704f85f0184f7a213cc4d62bd9654c-alt test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"` Nov 17 22:54:56.516 INFO [stdout] 0988f6f948b59c87e4e02d8b5e70187d6d8912fa812f0c026fc396cc5c28449c Nov 17 22:54:56.528 INFO running `"docker" "start" "-a" "0988f6f948b59c87e4e02d8b5e70187d6d8912fa812f0c026fc396cc5c28449c"` Nov 17 22:54:57.119 INFO [stderr] usermod: no changes Nov 17 22:54:57.271 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 0.13s Nov 17 22:54:57.295 INFO [stderr] Running /target/debug/deps/silk-66020bae8d715b17 Nov 17 22:54:57.295 INFO [stdout] Nov 17 22:54:57.295 INFO [stdout] running 22 tests Nov 17 22:54:57.307 INFO [stdout] test entry::tests::test_event_verify ... ok Nov 17 22:54:57.323 INFO [stdout] test entry::tests::test_next_tick ... ok Nov 17 22:54:57.325 INFO [stdout] test accountant::tests::test_cancel_transfer ... ok Nov 17 22:54:57.325 INFO [stdout] test historian::tests::test_duplicate_event_signature ... ok Nov 17 22:54:57.327 INFO [stdout] {"num_hashes":1,"id":[147,28,165,79,88,30,217,48,91,190,48,81,125,150,215,192,4,237,208,215,193,249,16,223,129,60,41,175,43,238,131,20],"event":{"Transaction":{"from":[101,45,23,98,155,12,123,141,189,247,114,143,164,114,193,42,240,68,177,252,200,16,69,70,251,168,234,88,109,135,246,163],"to":[108,254,29,220,241,202,13,244,207,215,121,214,238,75,0,94,43,157,9,2,203,167,76,98,226,32,62,246,209,14,95,88],"if_all":[{"Timestamp":"2018-11-17T22:54:57.313869022Z"}],"unless_any":[{"Signature":[101,45,23,98,155,12,123,141,189,247,114,143,164,114,193,42,240,68,177,252,200,16,69,70,251,168,234,88,109,135,246,163]}],"asset":1,"last_id":[171,126,145,6,103,106,162,19,106,221,10,182,232,136,95,150,165,243,143,231,90,26,164,26,35,67,108,48,132,83,223,55],"sig":[115,253,170,85,53,82,129,183,237,76,190,47,189,236,117,58,123,74,184,65,216,210,219,97,103,184,21,72,165,178,221,119,230,146,102,231,219,147,232,173,105,182,38,184,59,183,14,247,117,119,49,34,124,29,62,148,231,96,144,203,27,149,236,0]}}} Nov 17 22:54:57.328 INFO [stdout] {"num_hashes":1,"id":[215,14,140,127,32,246,97,157,20,149,154,64,164,80,110,136,34,119,80,83,93,0,24,113,32,103,8,253,172,206,197,195],"event":{"Transaction":{"from":[186,239,117,209,78,61,39,157,236,81,208,144,157,99,82,34,87,245,105,78,34,122,243,182,75,79,63,10,89,195,21,145],"to":[177,209,164,73,42,133,114,25,94,141,233,230,62,82,136,108,119,48,145,130,240,64,24,97,95,94,179,43,241,212,86,59],"if_all":[],"unless_any":[],"asset":1000,"last_id":[45,135,154,30,168,37,17,39,106,24,114,57,13,48,141,55,35,15,68,61,35,33,7,15,206,169,42,150,16,163,146,75],"sig":[38,209,198,210,32,166,98,246,139,218,213,213,93,44,99,7,58,57,8,40,116,76,54,157,38,8,40,226,13,16,50,106,139,162,232,229,117,137,158,12,84,248,142,207,114,134,237,27,162,21,172,82,199,168,48,30,43,57,43,101,5,134,190,7]}}} Nov 17 22:54:57.329 INFO [stdout] {"num_hashes":1,"id":[136,158,190,173,215,115,140,251,91,40,50,13,237,94,142,46,82,184,38,126,209,48,229,108,214,79,82,234,125,21,49,0],"event":{"Transaction":{"from":[186,239,117,209,78,61,39,157,236,81,208,144,157,99,82,34,87,245,105,78,34,122,243,182,75,79,63,10,89,195,21,145],"to":[177,209,164,73,42,133,114,25,94,141,233,230,62,82,136,108,119,48,145,130,240,64,24,97,95,94,179,43,241,212,86,59],"if_all":[],"unless_any":[],"asset":500,"last_id":[45,135,154,30,168,37,17,39,106,24,114,57,13,48,141,55,35,15,68,61,35,33,7,15,206,169,42,150,16,163,146,75],"sig":[231,30,28,202,132,79,178,18,6,246,69,109,241,83,140,198,169,164,108,98,31,79,108,139,51,130,168,155,208,146,79,255,141,253,9,85,78,171,6,38,118,65,129,169,200,117,53,7,49,149,181,249,109,87,90,153,180,135,214,62,186,132,201,10]}}} Nov 17 22:54:57.331 INFO [stdout] test accountant::tests::test_accountant ... ok Nov 17 22:54:57.340 INFO [stdout] {"num_hashes":1,"id":[111,2,228,222,136,33,214,172,182,58,152,206,196,243,209,40,55,62,10,138,74,160,233,171,224,0,53,129,94,192,223,130],"event":{"Transaction":{"from":[162,22,61,100,71,89,89,127,130,237,156,106,154,104,112,137,227,185,113,124,237,45,60,84,38,221,253,37,94,50,125,181],"to":[224,144,200,196,221,245,87,129,136,138,28,74,162,166,177,227,20,161,63,25,106,71,149,178,4,112,170,154,91,220,42,223],"if_all":[],"unless_any":[],"asset":1000,"last_id":[99,96,89,104,233,123,105,128,244,233,167,39,196,67,125,145,204,75,154,223,201,139,187,100,188,38,87,159,219,12,27,200],"sig":[136,107,30,87,38,119,249,189,100,189,8,191,52,147,217,106,250,9,193,104,60,127,3,189,133,86,209,123,107,186,117,236,103,42,141,6,121,81,136,120,26,187,40,5,122,178,209,73,78,26,83,233,58,118,177,168,248,240,182,85,69,59,207,8]}}} Nov 17 22:54:57.359 INFO [stdout] {"num_hashes":1,"id":[145,120,102,72,245,117,59,245,102,12,46,161,233,68,94,118,164,211,157,211,123,109,76,15,96,116,86,221,252,234,252,134],"event":{"Transaction":{"from":[226,198,229,196,250,106,52,62,176,177,241,148,45,11,1,17,115,3,82,209,77,44,118,49,181,34,196,33,23,195,140,74],"to":[143,93,141,2,2,87,225,142,133,135,47,77,12,15,201,6,24,124,178,71,26,23,170,98,215,251,59,115,184,218,128,234],"if_all":[{"Timestamp":"2018-11-17T22:54:57.337706289Z"}],"unless_any":[{"Signature":[226,198,229,196,250,106,52,62,176,177,241,148,45,11,1,17,115,3,82,209,77,44,118,49,181,34,196,33,23,195,140,74]}],"asset":1,"last_id":[251,121,139,116,125,75,88,10,225,27,104,127,42,184,96,254,254,144,189,56,126,96,171,76,181,209,193,54,6,122,134,84],"sig":[65,50,23,113,46,234,185,150,15,194,123,111,71,77,49,61,74,189,213,152,236,184,84,49,149,198,63,214,91,108,249,2,156,230,239,178,44,176,181,93,127,160,172,149,106,164,183,19,39,16,55,243,16,214,9,109,124,28,124,5,94,111,83,13]}}} Nov 17 22:54:57.363 INFO [stdout] test accountant::tests::test_transfer_on_date ... ok Nov 17 22:54:57.363 INFO [stdout] test accountant::tests::test_invalid_transfer ... ok Nov 17 22:54:57.394 INFO [stdout] {"num_hashes":1,"id":[66,169,100,32,250,237,27,35,188,213,180,152,8,210,164,211,190,11,181,199,163,150,181,41,195,84,206,123,161,58,128,9],"event":{"Transaction":{"from":[208,150,217,131,12,122,127,198,208,87,156,25,226,139,187,127,72,186,127,252,150,253,119,215,185,52,2,164,184,122,110,130],"to":[217,153,148,176,128,118,153,187,145,0,72,235,224,71,53,99,238,1,200,199,235,87,151,63,155,93,252,248,108,107,193,120],"if_all":[],"unless_any":[],"asset":500,"last_id":[161,170,201,210,145,200,133,57,59,237,167,2,200,128,9,226,110,151,85,193,9,143,9,103,72,209,55,178,131,251,39,195],"sig":[42,83,138,193,36,48,235,84,255,90,165,132,195,42,252,241,105,61,236,93,172,227,209,87,77,171,132,193,150,209,70,176,243,51,45,57,73,181,155,55,135,112,41,166,3,168,126,190,162,52,91,54,113,93,132,110,16,63,219,250,136,141,164,5]}}} Nov 17 22:54:57.394 INFO [stdout] test accountant_stub::tests::test_accountant_stub ... ok Nov 17 22:54:57.403 INFO [stdout] test accountant::tests::test_transfer_after_date ... ok Nov 17 22:54:57.410 INFO [stdout] {"num_hashes":1,"id":[80,195,113,46,148,13,193,56,198,82,102,231,185,119,131,88,42,237,141,76,89,30,235,194,176,131,54,233,76,49,68,32],"event":{"Transaction":{"from":[7,179,39,20,39,137,125,209,244,147,200,102,113,213,242,233,226,3,63,246,85,94,108,6,116,45,218,251,171,87,50,132],"to":[122,227,219,131,106,203,155,253,175,91,18,144,191,254,54,138,219,84,73,171,82,220,190,193,224,207,35,78,61,45,48,77],"if_all":[],"unless_any":[],"asset":500,"last_id":[137,3,67,186,144,25,149,10,120,237,255,197,67,155,151,150,43,45,75,50,80,254,31,111,137,146,92,107,243,3,222,107],"sig":[158,28,125,56,64,81,43,165,103,136,165,147,224,119,110,42,82,175,224,8,0,97,117,230,30,34,194,229,80,112,26,100,225,202,128,240,161,220,134,111,142,102,205,249,15,60,191,156,214,189,62,212,228,70,153,145,197,74,198,33,109,132,187,10]}}} Nov 17 22:54:57.411 INFO [stdout] {"num_hashes":0,"id":[0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0],"event":"Tick"} Nov 17 22:54:57.411 INFO [stdout] {"num_hashes":0,"id":[7,43,76,68,87,157,34,187,47,74,10,111,157,233,17,165,144,91,26,28,238,142,117,216,79,117,213,69,117,230,73,61],"event":"Tick"} Nov 17 22:54:57.431 INFO [stdout] test historian::tests::test_historian_closed_sender ... ok Nov 17 22:54:57.431 INFO [stdout] test accountant::tests::test_transfer_to_newb ... ok Nov 17 22:54:57.431 INFO [stdout] test mint::tests::test_create_events ... ok Nov 17 22:54:57.431 INFO [stdout] {"num_hashes":0,"id":[0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0],"event":"Tick"} Nov 17 22:54:57.431 INFO [stdout] test log::tests::test_verify_slice ... ok Nov 17 22:54:57.431 INFO [stdout] {"num_hashes":0,"id":[0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0],"event":"Tick"} Nov 17 22:54:57.431 INFO [stdout] {"num_hashes":0,"id":[0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0],"event":"Tick"} Nov 17 22:54:57.479 INFO [stdout] {"num_hashes":0,"id":[0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0],"event":"Tick"} Nov 17 22:54:57.479 INFO [stdout] {"num_hashes":0,"id":[0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0],"event":"Tick"} Nov 17 22:54:57.483 INFO [stdout] {"num_hashes":1,"id":[184,244,35,170,64,117,171,85,133,59,228,80,13,88,176,60,98,227,17,196,118,129,186,214,63,37,56,77,163,58,210,83],"event":{"Transaction":{"from":[225,165,25,252,115,51,206,74,245,201,210,77,248,189,250,206,231,101,218,32,68,42,126,249,50,242,140,35,160,250,0,199],"to":[231,230,69,128,148,171,163,173,232,235,135,136,133,243,206,140,225,127,141,251,241,198,202,190,129,26,78,149,235,11,28,135],"if_all":[{"Timestamp":"2018-11-17T22:54:57.392016071Z"}],"unless_any":[{"Signature":[225,165,25,252,115,51,206,74,245,201,210,77,248,189,250,206,231,101,218,32,68,42,126,249,50,242,140,35,160,250,0,199]}],"asset":1,"last_id":[7,43,76,68,87,157,34,187,47,74,10,111,157,233,17,165,144,91,26,28,238,142,117,216,79,117,213,69,117,230,73,61],"sig":[40,185,250,50,96,156,129,60,203,227,75,184,39,141,112,193,231,75,140,253,127,116,116,149,29,2,157,99,157,21,148,191,250,243,125,129,110,136,8,110,217,66,93,186,208,11,2,27,88,155,138,48,128,56,129,27,167,75,228,104,196,166,135,12]}}} Nov 17 22:54:57.511 INFO [stdout] test transaction::tests::test_claim ... ok Nov 17 22:54:57.511 INFO [stdout] test transaction::tests::test_hijack_attack ... ok Nov 17 22:54:57.511 INFO [stdout] test log::tests::test_reorder_attack ... ok Nov 17 22:54:57.511 INFO [stdout] test historian::tests::test_historian ... ok Nov 17 22:54:57.513 INFO [stdout] test transaction::tests::test_bad_event_signature ... ok Nov 17 22:54:57.515 INFO [stdout] test mint::tests::test_verify_entries ... ok Nov 17 22:54:57.547 INFO [stdout] test transaction::tests::test_transfer ... ok Nov 17 22:54:57.547 INFO [stdout] test transaction::tests::test_serialize_claim ... ok Nov 17 22:54:57.649 INFO [stdout] test historian::tests::test_ticking_historian ... FAILED Nov 17 22:54:57.649 INFO [stdout] Nov 17 22:54:57.649 INFO [stdout] failures: Nov 17 22:54:57.649 INFO [stdout] Nov 17 22:54:57.649 INFO [stdout] ---- historian::tests::test_ticking_historian stdout ---- Nov 17 22:54:57.649 INFO [stdout] thread 'historian::tests::test_ticking_historian' panicked at 'assertion failed: `(left != right)` Nov 17 22:54:57.649 INFO [stdout] left: `[0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0]`, Nov 17 22:54:57.649 INFO [stdout] right: `[0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0]`', src/historian.rs:138:9 Nov 17 22:54:57.649 INFO [stdout] stack backtrace: Nov 17 22:54:57.649 INFO [stdout] 0: 0x55913aba3e93 - std::sys::unix::backtrace::tracing::imp::unwind_backtrace::h1a944b80a560daa8 Nov 17 22:54:57.649 INFO [stdout] at libstd/sys/unix/backtrace/tracing/gcc_s.rs:49 Nov 17 22:54:57.649 INFO [stdout] 1: 0x55913ab9e0b8 - std::sys_common::backtrace::_print::h18f735b4c3a49bdb Nov 17 22:54:57.649 INFO [stdout] at libstd/sys_common/backtrace.rs:71 Nov 17 22:54:57.649 INFO [stdout] 2: 0x55913aba2914 - std::panicking::default_hook::{{closure}}::h97ab3548a215c097 Nov 17 22:54:57.649 INFO [stdout] at libstd/sys_common/backtrace.rs:59 Nov 17 22:54:57.649 INFO [stdout] at libstd/panicking.rs:211 Nov 17 22:54:57.649 INFO [stdout] 3: 0x55913aba25fc - std::panicking::default_hook::h98c2a01ef734e4b0 Nov 17 22:54:57.649 INFO [stdout] at libstd/panicking.rs:221 Nov 17 22:54:57.649 INFO [stdout] 4: 0x55913aba3020 - std::panicking::rust_panic_with_hook::hb4b3f28eb79ea752 Nov 17 22:54:57.649 INFO [stdout] at libstd/panicking.rs:476 Nov 17 22:54:57.649 INFO [stdout] 5: 0x55913aba2ba1 - std::panicking::continue_panic_fmt::h61fd5a7b1a268752 Nov 17 22:54:57.649 INFO [stdout] at libstd/panicking.rs:390 Nov 17 22:54:57.649 INFO [stdout] 6: 0x55913aba2aee - std::panicking::begin_panic_fmt::hfa6f19d29682fcb6 Nov 17 22:54:57.649 INFO [stdout] at libstd/panicking.rs:345 Nov 17 22:54:57.649 INFO [stdout] 7: 0x55913aaa2956 - silk::historian::tests::test_ticking_historian::hfc29af3d02230fac Nov 17 22:54:57.649 INFO [stdout] at src/historian.rs:138 Nov 17 22:54:57.649 INFO [stdout] 8: 0x55913aaa24a9 - silk::historian::tests::test_ticking_historian::{{closure}}::hcf02b5f940373b13 Nov 17 22:54:57.649 INFO [stdout] at src/historian.rs:125 Nov 17 22:54:57.649 INFO [stdout] 9: 0x55913aa3bd2d - core::ops::function::FnOnce::call_once::hb008c7d00047184d Nov 17 22:54:57.649 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libcore/ops/function.rs:238 Nov 17 22:54:57.649 INFO [stdout] 10: 0x55913aacc74e - >::call_box::h9dcb7fc9b8bb4240 Nov 17 22:54:57.649 INFO [stdout] at libtest/lib.rs:1471 Nov 17 22:54:57.649 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libcore/ops/function.rs:238 Nov 17 22:54:57.649 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/liballoc/boxed.rs:673 Nov 17 22:54:57.649 INFO [stdout] 11: 0x55913abb20d9 - __rust_maybe_catch_panic Nov 17 22:54:57.649 INFO [stdout] at libpanic_unwind/lib.rs:102 Nov 17 22:54:57.649 INFO [stdout] 12: 0x55913aac47b3 - std::sys_common::backtrace::__rust_begin_short_backtrace::h89ea8afe71e36f86 Nov 17 22:54:57.649 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panicking.rs:289 Nov 17 22:54:57.649 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panic.rs:398 Nov 17 22:54:57.650 INFO [stdout] at libtest/lib.rs:1426 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/sys_common/backtrace.rs:136 Nov 17 22:54:57.650 INFO [stdout] 13: 0x55913aac5664 - std::panicking::try::do_call::h4132042e0cbea3ae Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/thread/mod.rs:477 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panic.rs:319 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panicking.rs:310 Nov 17 22:54:57.650 INFO [stdout] 14: 0x55913abb20d9 - __rust_maybe_catch_panic Nov 17 22:54:57.650 INFO [stdout] at libpanic_unwind/lib.rs:102 Nov 17 22:54:57.650 INFO [stdout] 15: 0x55913aacc87c - >::call_box::hab7f616f05880bf6 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panicking.rs:289 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panic.rs:398 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/thread/mod.rs:476 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/liballoc/boxed.rs:673 Nov 17 22:54:57.650 INFO [stdout] 16: 0x55913aba5f1d - std::sys::unix::thread::Thread::new::thread_start::h5f8d67158a1ca038 Nov 17 22:54:57.650 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/liballoc/boxed.rs:683 Nov 17 22:54:57.650 INFO [stdout] at libstd/sys_common/thread.rs:24 Nov 17 22:54:57.650 INFO [stdout] at libstd/sys/unix/thread.rs:90 Nov 17 22:54:57.650 INFO [stdout] 17: 0x7f585da886b9 - start_thread Nov 17 22:54:57.650 INFO [stdout] 18: 0x7f585d5a841c - clone Nov 17 22:54:57.650 INFO [stdout] 19: 0x0 - Nov 17 22:54:57.650 INFO [stdout] Nov 17 22:54:57.650 INFO [stdout] Nov 17 22:54:57.650 INFO [stdout] failures: Nov 17 22:54:57.650 INFO [stdout] historian::tests::test_ticking_historian Nov 17 22:54:57.650 INFO [stdout] Nov 17 22:54:57.650 INFO [stdout] test result: FAILED. 21 passed; 1 failed; 0 ignored; 0 measured; 0 filtered out Nov 17 22:54:57.650 INFO [stdout] Nov 17 22:54:57.654 INFO [stderr] error: test failed, to rerun pass '--lib' Nov 17 22:54:57.656 INFO [stderr] su: No module specific data is present Nov 17 22:54:58.494 INFO running `"docker" "inspect" "0988f6f948b59c87e4e02d8b5e70187d6d8912fa812f0c026fc396cc5c28449c"` Nov 17 22:54:58.791 INFO running `"docker" "rm" "-f" "0988f6f948b59c87e4e02d8b5e70187d6d8912fa812f0c026fc396cc5c28449c"` Nov 17 22:54:59.036 INFO [stdout] 0988f6f948b59c87e4e02d8b5e70187d6d8912fa812f0c026fc396cc5c28449c