Dec 14 18:35:42.910 INFO testing stack-vm-0.3.0 against try#aa49d8ef14939ddec0e34b346b60174a5673d48f for pr-56550
Dec 14 18:35:42.910 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-4/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-4/pr-56550/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/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 +aa49d8ef14939ddec0e34b346b60174a5673d48f-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"`
Dec 14 18:35:43.287 INFO [stdout] f9213eb7331b20dd5156290ac696ff2602ca73ba640bf418a9ebeb3dc7f4aae9
Dec 14 18:35:43.293 INFO running `"docker" "start" "-a" "f9213eb7331b20dd5156290ac696ff2602ca73ba640bf418a9ebeb3dc7f4aae9"`
Dec 14 18:35:44.527 INFO [stderr] usermod: no changes
Dec 14 18:35:44.583 INFO [stderr]    Compiling stack-vm v0.3.0 (/source)
Dec 14 18:35:45.803 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 1.24s
Dec 14 18:35:45.811 INFO [stderr] su: No module specific data is present
Dec 14 18:35:46.519 INFO running `"docker" "inspect" "f9213eb7331b20dd5156290ac696ff2602ca73ba640bf418a9ebeb3dc7f4aae9"`
Dec 14 18:35:46.719 INFO running `"docker" "rm" "-f" "f9213eb7331b20dd5156290ac696ff2602ca73ba640bf418a9ebeb3dc7f4aae9"`
Dec 14 18:35:46.958 INFO [stdout] f9213eb7331b20dd5156290ac696ff2602ca73ba640bf418a9ebeb3dc7f4aae9
Dec 14 18:35:46.964 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-4/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-4/pr-56550/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/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 +aa49d8ef14939ddec0e34b346b60174a5673d48f-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"`
Dec 14 18:35:47.331 INFO [stdout] 4776685a3f427a43afa9545520a2f00c419f7a246e6c317d3fa0e755ad9c888d
Dec 14 18:35:47.333 INFO running `"docker" "start" "-a" "4776685a3f427a43afa9545520a2f00c419f7a246e6c317d3fa0e755ad9c888d"`
Dec 14 18:35:48.485 INFO [stderr] usermod: no changes
Dec 14 18:35:48.535 INFO [stderr]    Compiling stack-vm v0.3.0 (/source)
Dec 14 18:35:53.591 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 5.09s
Dec 14 18:35:53.591 INFO [stderr] su: No module specific data is present
Dec 14 18:35:54.208 INFO running `"docker" "inspect" "4776685a3f427a43afa9545520a2f00c419f7a246e6c317d3fa0e755ad9c888d"`
Dec 14 18:35:54.493 INFO running `"docker" "rm" "-f" "4776685a3f427a43afa9545520a2f00c419f7a246e6c317d3fa0e755ad9c888d"`
Dec 14 18:35:54.779 INFO [stdout] 4776685a3f427a43afa9545520a2f00c419f7a246e6c317d3fa0e755ad9c888d
Dec 14 18:35:54.787 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-4/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-4/pr-56550/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/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 +aa49d8ef14939ddec0e34b346b60174a5673d48f-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"`
Dec 14 18:35:55.331 INFO [stdout] 544d23475cd95fc3e1f5edc18a7fe8cdd7a220c2433164b014c5332a759c2eee
Dec 14 18:35:55.339 INFO running `"docker" "start" "-a" "544d23475cd95fc3e1f5edc18a7fe8cdd7a220c2433164b014c5332a759c2eee"`
Dec 14 18:35:56.270 INFO [stderr] usermod: no changes
Dec 14 18:35:56.343 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.03s
Dec 14 18:35:56.359 INFO [stderr]      Running /target/debug/deps/stack_vm-73af510bc792b704
Dec 14 18:35:56.359 INFO [stdout] 
Dec 14 18:35:56.359 INFO [stdout] running 39 tests
Dec 14 18:35:56.359 INFO [stdout] test builder::test::debug_format ... ok
Dec 14 18:35:56.359 INFO [stdout] test acceptance::functions::example ... ok
Dec 14 18:35:56.359 INFO [stdout] test builder::test::data_is_deduped ... ok
Dec 14 18:35:56.359 INFO [stdout] test acceptance::arithmetic::subtraction_example ... ok
Dec 14 18:35:56.359 INFO [stdout] test builder::test::new ... ok
Dec 14 18:35:56.359 INFO [stdout] test builder::test::label ... ok
Dec 14 18:35:56.359 INFO [stdout] test builder::test::push ... ok
Dec 14 18:35:56.359 INFO [stdout] test acceptance::arithmetic::multiplication_example ... ok
Dec 14 18:35:56.359 INFO [stdout] test acceptance::arithmetic::division_example ... ok
Dec 14 18:35:56.359 INFO [stdout] test code::test::debug_formatter ... ok
Dec 14 18:35:56.359 INFO [stdout] test code::test::from_builder ... ok
Dec 14 18:35:56.359 INFO [stdout] test code::test::get_label_ip ... ok
Dec 14 18:35:56.359 INFO [stdout] test code::test::to_byte_code ... ok
Dec 14 18:35:56.359 INFO [stdout] test instruction::test::new ... ok
Dec 14 18:35:56.359 INFO [stdout] test frame::test::new_has_locals ... ok
Dec 14 18:35:56.359 INFO [stdout] test from_byte_code::test::from_byte_code ... ok
Dec 14 18:35:56.359 INFO [stdout] test acceptance::arithmetic::addition_example ... ok
Dec 14 18:35:56.359 INFO [stdout] test code::test::from_byte_code ... ok
Dec 14 18:35:56.365 INFO [stdout] test machine::test::new ... ok
Dec 14 18:35:56.365 INFO [stdout] test machine::test::set_local ... ok
Dec 14 18:35:56.365 INFO [stdout] test machine::test::run ... ok
Dec 14 18:35:56.365 INFO [stdout] test machine::test::get_local_deep ... ok
Dec 14 18:35:56.365 INFO [stdout] test machine::test::get_local ... ok
Dec 14 18:35:56.365 INFO [stdout] test stack::test::pop ... ok
Dec 14 18:35:56.365 INFO [stdout] test stack::test::push ... ok
Dec 14 18:35:56.365 INFO [stdout] test to_byte_code::test::to_byte_code ... ok
Dec 14 18:35:56.365 INFO [stdout] test write_many_table::test::insert ... ok
Dec 14 18:35:56.365 INFO [stdout] test write_many_table::test::insert_is_mutable ... ok
Dec 14 18:35:56.365 INFO [stdout] test write_many_table::test::new ... ok
Dec 14 18:35:56.365 INFO [stdout] test write_once_table::test::insert ... ok
Dec 14 18:35:56.365 INFO [stdout] test stack::test::new ... ok
Dec 14 18:35:56.371 INFO [stdout] test stack::test::peek ... ok
Dec 14 18:35:56.371 INFO [stdout] test instruction_table::test::new ... ok
Dec 14 18:35:56.371 INFO [stdout] test instruction_table::test::insert ... ok
Dec 14 18:35:56.371 INFO [stdout] test write_once_table::test::new ... ok
Dec 14 18:35:56.439 INFO [stdout] test builder::test::push_with_incorrect_arity ... ok
Dec 14 18:35:56.445 INFO [stdout] test stack::test::empty_peek ... ok
Dec 14 18:35:56.445 INFO [stdout] test write_once_table::test::insert_uniq ... ok
Dec 14 18:35:56.451 INFO [stdout] test stack::test::empty_pop ... ok
Dec 14 18:35:56.451 INFO [stdout] 
Dec 14 18:35:56.451 INFO [stdout] test result: ok. 39 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 14 18:35:56.451 INFO [stdout] 
Dec 14 18:35:56.451 INFO [stderr]    Doc-tests stack-vm
Dec 14 18:35:57.750 INFO [stdout] 
Dec 14 18:35:57.750 INFO [stdout] running 17 tests
Dec 14 18:36:05.003 INFO [stdout] test src/instruction.rs - instruction (line 36) ... ok
Dec 14 18:36:05.447 INFO [stdout] test src/from_byte_code.rs - from_byte_code::FromByteCode::from_byte_code (line 24) ... ok
Dec 14 18:36:07.148 INFO [stdout] test src/instruction.rs - instruction (line 23) ... ok
Dec 14 18:36:08.575 INFO [stdout] test src/code/mod.rs - code (line 63) ... ok
Dec 14 18:36:09.427 INFO [stdout] test src/instruction.rs - instruction (line 10) ... ok
Dec 14 18:36:10.384 INFO [stdout] test src/code/mod.rs - code (line 36) ... ok
Dec 14 18:36:10.592 INFO [stdout] test src/builder.rs - builder (line 7) ... ok
Dec 14 18:36:12.967 INFO [stdout] test src/code/mod.rs - code (line 11) ... ok
Dec 14 18:36:15.823 INFO [stdout] test src/lib.rs -  (line 111) ... ok
Dec 14 18:36:16.751 INFO [stdout] test src/lib.rs -  (line 57) ... ok
Dec 14 18:36:20.720 INFO [stdout] test src/to_byte_code.rs - to_byte_code::ToByteCode::to_byte_code (line 30) ... ok
Dec 14 18:36:20.831 INFO [stdout] test src/stack.rs - stack::Stack (line 10) ... ok
Dec 14 18:36:22.019 INFO [stdout] test src/lib.rs -  (line 83) ... ok
Dec 14 18:36:22.310 INFO [stdout] test src/lib.rs -  (line 153) ... ok
Dec 14 18:36:22.323 INFO [stdout] test src/write_many_table.rs - write_many_table::WriteManyTable (line 9) ... ok
Dec 14 18:36:22.666 INFO [stdout] test src/write_once_table.rs - write_once_table::WriteOnceTable (line 23) ... ok
Dec 14 18:36:23.500 INFO [stdout] test src/write_once_table.rs - write_once_table::WriteOnceTable (line 9) ... ok
Dec 14 18:36:23.500 INFO [stdout] 
Dec 14 18:36:23.501 INFO [stdout] test result: ok. 17 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 14 18:36:23.501 INFO [stdout] 
Dec 14 18:36:23.541 INFO [stderr] su: No module specific data is present
Dec 14 18:36:24.315 INFO running `"docker" "inspect" "544d23475cd95fc3e1f5edc18a7fe8cdd7a220c2433164b014c5332a759c2eee"`
Dec 14 18:36:24.565 INFO running `"docker" "rm" "-f" "544d23475cd95fc3e1f5edc18a7fe8cdd7a220c2433164b014c5332a759c2eee"`
Dec 14 18:36:24.819 INFO [stdout] 544d23475cd95fc3e1f5edc18a7fe8cdd7a220c2433164b014c5332a759c2eee