[INFO] fetching crate port-expander 0.6.5...
[INFO] testing port-expander-0.6.5 against master#cdb45c87e2cd43495379f7e867e3cc15dcee9f93 for pr-145838-1
[INFO] extracting crate port-expander 0.6.5 into /workspace/builds/worker-4-tc1/source
[INFO] started tweaking crates.io crate port-expander 0.6.5
[INFO] finished tweaking crates.io crate port-expander 0.6.5
[INFO] tweaked toml for crates.io crate port-expander 0.6.5 written to /workspace/builds/worker-4-tc1/source/Cargo.toml
[INFO] validating manifest of crates.io crate port-expander 0.6.5 on toolchain cdb45c87e2cd43495379f7e867e3cc15dcee9f93
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+cdb45c87e2cd43495379f7e867e3cc15dcee9f93" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate crates.io crate port-expander 0.6.5 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" "+cdb45c87e2cd43495379f7e867e3cc15dcee9f93" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-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:7ad1b28ee6f5f7f699f6cf7015098d6ccdd96d6f2d78dd06228f5b4c9faf309c" "/opt/rustwide/cargo-home/bin/cargo" "+cdb45c87e2cd43495379f7e867e3cc15dcee9f93" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] c3009afda8c67db3c8a6c50d0df06def8d4c1af593b7dbd89bf952411d83c586
[INFO] running `Command { std: "docker" "start" "-a" "c3009afda8c67db3c8a6c50d0df06def8d4c1af593b7dbd89bf952411d83c586", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "c3009afda8c67db3c8a6c50d0df06def8d4c1af593b7dbd89bf952411d83c586", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "c3009afda8c67db3c8a6c50d0df06def8d4c1af593b7dbd89bf952411d83c586", kill_on_drop: false }`
[INFO] [stdout] c3009afda8c67db3c8a6c50d0df06def8d4c1af593b7dbd89bf952411d83c586
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-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:7ad1b28ee6f5f7f699f6cf7015098d6ccdd96d6f2d78dd06228f5b4c9faf309c" "/opt/rustwide/cargo-home/bin/cargo" "+cdb45c87e2cd43495379f7e867e3cc15dcee9f93" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] c1e05676a04cba09ba5616ece1784d7fa3cb916a108761cbe8a3be47a1f33d2f
[INFO] running `Command { std: "docker" "start" "-a" "c1e05676a04cba09ba5616ece1784d7fa3cb916a108761cbe8a3be47a1f33d2f", kill_on_drop: false }`
[INFO] [stderr]    Compiling embedded-hal v1.0.0
[INFO] [stderr]    Compiling port-expander v0.6.5 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `dev` profile [unoptimized + debuginfo] target(s) in 0.57s
[INFO] running `Command { std: "docker" "inspect" "c1e05676a04cba09ba5616ece1784d7fa3cb916a108761cbe8a3be47a1f33d2f", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "c1e05676a04cba09ba5616ece1784d7fa3cb916a108761cbe8a3be47a1f33d2f", kill_on_drop: false }`
[INFO] [stdout] c1e05676a04cba09ba5616ece1784d7fa3cb916a108761cbe8a3be47a1f33d2f
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-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:7ad1b28ee6f5f7f699f6cf7015098d6ccdd96d6f2d78dd06228f5b4c9faf309c" "/opt/rustwide/cargo-home/bin/cargo" "+cdb45c87e2cd43495379f7e867e3cc15dcee9f93" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] 118f5f303459b81d0bf3b5367a8f878dfc1d126d8898e986a192991ce2def8e6
[INFO] running `Command { std: "docker" "start" "-a" "118f5f303459b81d0bf3b5367a8f878dfc1d126d8898e986a192991ce2def8e6", kill_on_drop: false }`
[INFO] [stderr]    Compiling num-traits v0.2.16
[INFO] [stderr]    Compiling num-rational v0.3.2
[INFO] [stderr]    Compiling num-iter v0.1.43
[INFO] [stderr]    Compiling num-integer v0.1.45
[INFO] [stderr]    Compiling nb v1.1.0
[INFO] [stderr]    Compiling void v1.0.2
[INFO] [stderr]    Compiling nb v0.1.3
[INFO] [stderr]    Compiling embedded-hal-nb v1.0.0
[INFO] [stderr]    Compiling embedded-hal v0.2.7
[INFO] [stderr]    Compiling num-complex v0.3.1
[INFO] [stderr]    Compiling num v0.3.1
[INFO] [stderr]    Compiling embedded-time v0.12.1
[INFO] [stderr]    Compiling embedded-hal-mock v0.11.1
[INFO] [stderr]    Compiling port-expander v0.6.5 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 6.63s
[INFO] running `Command { std: "docker" "inspect" "118f5f303459b81d0bf3b5367a8f878dfc1d126d8898e986a192991ce2def8e6", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "118f5f303459b81d0bf3b5367a8f878dfc1d126d8898e986a192991ce2def8e6", kill_on_drop: false }`
[INFO] [stdout] 118f5f303459b81d0bf3b5367a8f878dfc1d126d8898e986a192991ce2def8e6
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-4-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:7ad1b28ee6f5f7f699f6cf7015098d6ccdd96d6f2d78dd06228f5b4c9faf309c" "/opt/rustwide/cargo-home/bin/cargo" "+cdb45c87e2cd43495379f7e867e3cc15dcee9f93" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] e31730d253928084f12709184bb58e895bfb6bca69c50c2834df31d86fb9fa07
[INFO] running `Command { std: "docker" "start" "-a" "e31730d253928084f12709184bb58e895bfb6bca69c50c2834df31d86fb9fa07", kill_on_drop: false }`
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 0.05s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/port_expander-e2cc6773bb230c21)
[INFO] [stdout] 
[INFO] [stdout] running 23 tests
[INFO] [stdout] test dev::max7321::tests::max7321 ... ok
[INFO] [stdout] test dev::pca9536::tests::pca9536 ... ok
[INFO] [stdout] test dev::pca9554::tests::pca9554 ... ok
[INFO] [stdout] test dev::pca9538::tests::pca9538 ... ok
[INFO] [stdout] test dev::mcp23x17::tests::mcp23s17 ... ok
[INFO] [stdout] test dev::pca9555::tests::pca9555 ... ok
[INFO] [stdout] test dev::pcal6408a::tests::pca6408a ... ok
[INFO] [stdout] test dev::pcf8574::tests::pcf8574 ... ok
[INFO] [stdout] test dev::pcf8574::tests::pcf8574a ... ok
[INFO] [stdout] test dev::pca9702::tests::pca9702_read_inputs ... ok
[INFO] [stdout] test dev::pcal6416a::tests::pca6416a ... ok
[INFO] [stdout] test dev::pcf8575::tests::pcf8575 ... ok
[INFO] [stdout] test dev::tca6408a::tests::tca6408a ... ok
[INFO] [stdout] test dev::pi4ioe5v6408::tests::pi4ioe5v6408 ... ok
[INFO] [stdout] test multi::tests::pca9536_read_multiple ... ok
[INFO] [stdout] test dev::pi4ioe5v6408::tests::pi4ioe5v6408_retained ... ok
[INFO] [stdout] test multi::tests::pca9702_read_multiple ... ok
[INFO] [stdout] test multi::tests::pcf8574_write_multiple ... ok
[INFO] [stdout] test multi::tests::pcf8575_write_multiple ... ok
[INFO] [stdout] test dev::pca9554::tests::pca9554a ... ok
[INFO] [stdout] test dev::mcp23x17::tests::mcp23017 ... ok
[INFO] [stdout] test dev::pca9702::tests::pca9702_output_fails - should panic ... ok
[INFO] [stdout] test multi::tests::pca9538_multiple_assert_same_chip - should panic ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 23 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.02s
[INFO] [stdout] 
[INFO] [stderr]    Doc-tests port_expander
[INFO] [stdout] 
[INFO] [stdout] running 7 tests
[INFO] [stdout] test src/lib.rs - (line 49) ... ignored
[INFO] [stdout] test src/multi.rs - multi::write_multiple (line 5) - compile ... ok
[INFO] [stdout] test src/multi.rs - multi::read_multiple (line 83) - compile ... ok
[INFO] [stdout] test src/multi.rs - multi::read_multiple (line 64) - compile ... ok
[INFO] [stdout] test src/lib.rs - (line 7) - compile ... ok
[INFO] [stdout] test src/multi.rs - multi::write_multiple (line 20) - compile ... ok
[INFO] [stdout] test src/mutex.rs - mutex::PortMutex (line 22) ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 6 passed; 0 failed; 1 ignored; 0 measured; 0 filtered out; finished in 0.25s
[INFO] [stdout] 
[INFO] running `Command { std: "docker" "inspect" "e31730d253928084f12709184bb58e895bfb6bca69c50c2834df31d86fb9fa07", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "e31730d253928084f12709184bb58e895bfb6bca69c50c2834df31d86fb9fa07", kill_on_drop: false }`
[INFO] [stdout] e31730d253928084f12709184bb58e895bfb6bca69c50c2834df31d86fb9fa07