[INFO] cloning repository https://github.com/paigeadelethompson/rust-m88k
[INFO] running `Command { std: "git" "-c" "credential.helper=" "-c" "credential.helper=/workspace/cargo-home/bin/git-credential-null" "clone" "--bare" "https://github.com/paigeadelethompson/rust-m88k" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Fpaigeadelethompson%2Frust-m88k", kill_on_drop: false }`
[INFO] [stderr] Cloning into bare repository '/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Fpaigeadelethompson%2Frust-m88k'...
[INFO] running `Command { std: "git" "rev-parse" "HEAD", kill_on_drop: false }`
[INFO] [stdout] 578a129efd82c5dff019eeffbf8c33cd09b491b6
[INFO] testing paigeadelethompson/rust-m88k against try#8de4c7234dd9b97c9d76b58671343fdbbc9a433e+target=x86_64-unknown-linux-musl for musl_upgrade_1_2_5_with_libc_patch_0
[INFO] running `Command { std: "git" "clone" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Fpaigeadelethompson%2Frust-m88k" "/workspace/builds/worker-1-tc1/source", kill_on_drop: false }`
[INFO] [stderr] Cloning into '/workspace/builds/worker-1-tc1/source'...
[INFO] [stderr] done.
[INFO] started tweaking git repo https://github.com/paigeadelethompson/rust-m88k
[INFO] finished tweaking git repo https://github.com/paigeadelethompson/rust-m88k
[INFO] tweaked toml for git repo https://github.com/paigeadelethompson/rust-m88k written to /workspace/builds/worker-1-tc1/source/Cargo.toml
[INFO] validating manifest of git repo https://github.com/paigeadelethompson/rust-m88k on toolchain 8de4c7234dd9b97c9d76b58671343fdbbc9a433e
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+8de4c7234dd9b97c9d76b58671343fdbbc9a433e" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate git repo https://github.com/paigeadelethompson/rust-m88k already has a lockfile, it will not be regenerated
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+8de4c7234dd9b97c9d76b58671343fdbbc9a433e" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:90999bfc7ae267e83380e433d8e61a7c072ca6729e92edbae886d3423b3a6f4c" "/opt/rustwide/cargo-home/bin/cargo" "+8de4c7234dd9b97c9d76b58671343fdbbc9a433e" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] d8b304db780256e197f49a16b32ccad029e55675955ec9458e30bb0f0355ed41
[INFO] running `Command { std: "docker" "start" "-a" "d8b304db780256e197f49a16b32ccad029e55675955ec9458e30bb0f0355ed41", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "d8b304db780256e197f49a16b32ccad029e55675955ec9458e30bb0f0355ed41", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "d8b304db780256e197f49a16b32ccad029e55675955ec9458e30bb0f0355ed41", kill_on_drop: false }`
[INFO] [stdout] d8b304db780256e197f49a16b32ccad029e55675955ec9458e30bb0f0355ed41
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:90999bfc7ae267e83380e433d8e61a7c072ca6729e92edbae886d3423b3a6f4c" "/opt/rustwide/cargo-home/bin/cargo" "+8de4c7234dd9b97c9d76b58671343fdbbc9a433e" "build" "--frozen" "--message-format=json" "--target" "x86_64-unknown-linux-musl", kill_on_drop: false }`
[INFO] [stdout] 3f4c6669c1f4cf1893272fe3b534184f49ca7e701207f894e38f9d12b2b6747f
[INFO] running `Command { std: "docker" "start" "-a" "3f4c6669c1f4cf1893272fe3b534184f49ca7e701207f894e38f9d12b2b6747f", kill_on_drop: false }`
[INFO] [stderr]    Compiling rust-m88k v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `dev` profile [unoptimized + debuginfo] target(s) in 0.61s
[INFO] running `Command { std: "docker" "inspect" "3f4c6669c1f4cf1893272fe3b534184f49ca7e701207f894e38f9d12b2b6747f", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "3f4c6669c1f4cf1893272fe3b534184f49ca7e701207f894e38f9d12b2b6747f", kill_on_drop: false }`
[INFO] [stdout] 3f4c6669c1f4cf1893272fe3b534184f49ca7e701207f894e38f9d12b2b6747f
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:90999bfc7ae267e83380e433d8e61a7c072ca6729e92edbae886d3423b3a6f4c" "/opt/rustwide/cargo-home/bin/cargo" "+8de4c7234dd9b97c9d76b58671343fdbbc9a433e" "test" "--frozen" "--no-run" "--message-format=json" "--target" "x86_64-unknown-linux-musl", kill_on_drop: false }`
[INFO] [stdout] d6389d1d2bdc0ee5ebcde2a7202021bdf954b13496c29094f356680f1629341f
[INFO] running `Command { std: "docker" "start" "-a" "d6389d1d2bdc0ee5ebcde2a7202021bdf954b13496c29094f356680f1629341f", kill_on_drop: false }`
[INFO] [stderr]    Compiling rust-m88k v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 1.32s
[INFO] running `Command { std: "docker" "inspect" "d6389d1d2bdc0ee5ebcde2a7202021bdf954b13496c29094f356680f1629341f", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "d6389d1d2bdc0ee5ebcde2a7202021bdf954b13496c29094f356680f1629341f", kill_on_drop: false }`
[INFO] [stdout] d6389d1d2bdc0ee5ebcde2a7202021bdf954b13496c29094f356680f1629341f
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:90999bfc7ae267e83380e433d8e61a7c072ca6729e92edbae886d3423b3a6f4c" "/opt/rustwide/cargo-home/bin/cargo" "+8de4c7234dd9b97c9d76b58671343fdbbc9a433e" "test" "--frozen" "--target" "x86_64-unknown-linux-musl", kill_on_drop: false }`
[INFO] [stdout] 73114bb222ed967a043aa5ed406baa2ce0b31667c87e8bc692e5bdd696c1b12c
[INFO] running `Command { std: "docker" "start" "-a" "73114bb222ed967a043aa5ed406baa2ce0b31667c87e8bc692e5bdd696c1b12c", kill_on_drop: false }`
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 0.02s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/x86_64-unknown-linux-musl/debug/deps/motorola88k-902984ebc36cdec2)
[INFO] [stdout] 
[INFO] [stdout] running 112 tests
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_add_immediate ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_add ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_addu_wraparound ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_add_overflow ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_cmp ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_div ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_div_overflow ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_divu ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_divud ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_ff0 ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_ff1 ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_div_boundary_cases ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_addu ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_mul ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_mul_boundary_cases ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_lmul ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_mask ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_mul_overflow ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_div_by_zero ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_mulu ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_rem ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_rem_by_zero ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_remu ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_sub ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_sub_immediate ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_subu ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_sub_underflow ... ok
[INFO] [stdout] test cpu::instructions::arithmetic::tests::test_subu_wraparound ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_beq ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_bge ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_ble ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_blt ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_bne ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_jal ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_jr ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_ldcr ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_rte ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_bgt ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_fdiv ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_float_compare_special_values ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_float_denormal_handling ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_float_div_by_zero ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_float_invalid_operations ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_float_overflow ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_fmul ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_trap ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_fadd ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_stcr ... ok
[INFO] [stdout] test cpu::instructions::control::tests::test_tbnd ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_fcmp ... ok
[INFO] [stdout] test cpu::instructions::logical::tests::test_and ... ok
[INFO] [stdout] test cpu::instructions::logical::tests::test_ext_byte ... ok
[INFO] [stdout] test cpu::instructions::logical::tests::test_ext_half ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_fsub ... ok
[INFO] [stdout] test cpu::instructions::logical::tests::test_makn ... ok
[INFO] [stdout] test cpu::instructions::logical::tests::test_extu_half ... ok
[INFO] [stdout] test cpu::instructions::logical::tests::test_extu_byte ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_int_to_fp ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_fp_to_int ... ok
[INFO] [stdout] test cpu::instructions::logical::tests::test_or ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_float_rounding_modes ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_load_half ... ok
[INFO] [stdout] test cpu::instructions::floating_point::tests::test_float_underflow ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_load_byte ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_load_double ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_exchange ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_load_page_fault ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_load_store ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_store_byte ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_load_store_with_offset ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_store_double ... ok
[INFO] [stdout] test cpu::instructions::mmu::tests::test_translate ... ok
[INFO] [stdout] test cpu::instructions::mmu::tests::test_tlb_invalidate ... ok
[INFO] [stdout] test cpu::instructions::memory_access::tests::test_store_half ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_cache_lock_operations ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_icache_privilege_levels ... ok
[INFO] [stdout] test cpu::instructions::mmu::tests::test_ptbr_privilege ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vdiv ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_veq ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vadd ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_cache_flush_error_handling ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_cache_invalidate_error_handling ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vextract_byte ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_cache_operations_state_preservation ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_cache_prefetch_user_mode ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vgt ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vinsert_byte ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_dcache_operations ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vinterleave_high ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vinterleave_low ... ok
[INFO] [stdout] test cpu::instructions::system::tests::test_cache_flush_sequence ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vlt ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vmin ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vmax ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vmove ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vmul ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vpack_bytes_to_halfwords ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vpack_halfwords_to_word ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vshuffle ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vsub ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vunpack_bytes_to_halfwords ... ok
[INFO] [stdout] test cpu::tests::test_mmu_control ... ok
[INFO] [stdout] test cpu::tests::test_privilege_level ... ok
[INFO] [stdout] test cpu::tests::test_set_fp_flag ... ok
[INFO] [stdout] test memory::tests::test_memory_access ... ok
[INFO] [stdout] test memory::tests::test_memory_initialization ... ok
[INFO] [stdout] test memory::tests::test_mmu_translation ... ok
[INFO] [stdout] test memory::tests::test_page_table_entry ... ok
[INFO] [stdout] test cpu::instructions::vector::tests::test_vunpack_halfwords_to_word ... ok
[INFO] [stdout] test cpu::tests::test_cpu_initialization ... ok
[INFO] [stdout] test cpu::tests::test_error_handling ... ok
[INFO] [stdout] test cpu::tests::test_privilege_violation ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 112 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.08s
[INFO] [stdout] 
[INFO] running `Command { std: "docker" "inspect" "73114bb222ed967a043aa5ed406baa2ce0b31667c87e8bc692e5bdd696c1b12c", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "73114bb222ed967a043aa5ed406baa2ce0b31667c87e8bc692e5bdd696c1b12c", kill_on_drop: false }`
[INFO] [stdout] 73114bb222ed967a043aa5ed406baa2ce0b31667c87e8bc692e5bdd696c1b12c