[INFO] fetching crate async-rustbus 0.2.0...
[INFO] testing async-rustbus-0.2.0 against 1.76.0 for beta-1.77-1
[INFO] extracting crate async-rustbus 0.2.0 into /workspace/builds/worker-7-tc1/source
[INFO] validating manifest of crates.io crate async-rustbus 0.2.0 on toolchain 1.76.0
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.76.0" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] started tweaking crates.io crate async-rustbus 0.2.0
[INFO] finished tweaking crates.io crate async-rustbus 0.2.0
[INFO] tweaked toml for crates.io crate async-rustbus 0.2.0 written to /workspace/builds/worker-7-tc1/source/Cargo.toml
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.76.0" "generate-lockfile" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] [stderr]     Updating crates.io index
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.76.0" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] [stderr]  Downloading crates ...
[INFO] [stderr]   Downloaded rustbus_derive v0.4.0
[INFO] [stderr]   Downloaded rustbus v0.17.0
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+1.76.0" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] b5d9912f0a69cde8f26ceb3e3a10ec221c86226eabe7465f5a40884a9878b8fc
[INFO] running `Command { std: "docker" "start" "-a" "b5d9912f0a69cde8f26ceb3e3a10ec221c86226eabe7465f5a40884a9878b8fc", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "b5d9912f0a69cde8f26ceb3e3a10ec221c86226eabe7465f5a40884a9878b8fc", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "b5d9912f0a69cde8f26ceb3e3a10ec221c86226eabe7465f5a40884a9878b8fc", kill_on_drop: false }`
[INFO] [stdout] b5d9912f0a69cde8f26ceb3e3a10ec221c86226eabe7465f5a40884a9878b8fc
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-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=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+1.76.0" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] e4eafce9ea74eb43f3018f0eb6815eb5e0b436c8e3d1b8761b43abf47a3caacb
[INFO] running `Command { std: "docker" "start" "-a" "e4eafce9ea74eb43f3018f0eb6815eb5e0b436c8e3d1b8761b43abf47a3caacb", kill_on_drop: false }`
[INFO] [stderr]    Compiling crossbeam-utils v0.8.19
[INFO] [stderr]    Compiling memoffset v0.6.5
[INFO] [stderr]    Compiling event-listener v2.5.3
[INFO] [stderr]    Compiling arrayvec v0.7.4
[INFO] [stderr]    Compiling xml-rs v0.8.19
[INFO] [stderr]    Compiling syn v2.0.48
[INFO] [stderr]    Compiling num_cpus v1.16.0
[INFO] [stderr]    Compiling mio v0.8.10
[INFO] [stderr]    Compiling socket2 v0.5.5
[INFO] [stderr]    Compiling rustbus_derive v0.4.0
[INFO] [stderr]    Compiling nix v0.22.3
[INFO] [stderr]    Compiling concurrent-queue v2.4.0
[INFO] [stderr]    Compiling async-channel v1.9.0
[INFO] [stderr]    Compiling futures-macro v0.3.30
[INFO] [stderr]    Compiling tokio-macros v2.2.0
[INFO] [stderr]    Compiling rustbus v0.17.0
[INFO] [stderr]    Compiling tokio v1.36.0
[INFO] [stderr]    Compiling futures-util v0.3.30
[INFO] [stderr]    Compiling futures-executor v0.3.30
[INFO] [stderr]    Compiling futures v0.3.30
[INFO] [stderr]    Compiling async-rustbus v0.2.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 6.16s
[INFO] running `Command { std: "docker" "inspect" "e4eafce9ea74eb43f3018f0eb6815eb5e0b436c8e3d1b8761b43abf47a3caacb", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "e4eafce9ea74eb43f3018f0eb6815eb5e0b436c8e3d1b8761b43abf47a3caacb", kill_on_drop: false }`
[INFO] [stdout] e4eafce9ea74eb43f3018f0eb6815eb5e0b436c8e3d1b8761b43abf47a3caacb
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-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=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+1.76.0" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] d1e72924110a5a1e3ecfbfe0c4a972b37325235673b2dcbe15f66cf2c1e6cb16
[INFO] running `Command { std: "docker" "start" "-a" "d1e72924110a5a1e3ecfbfe0c4a972b37325235673b2dcbe15f66cf2c1e6cb16", kill_on_drop: false }`
[INFO] [stderr]    Compiling getrandom v0.2.12
[INFO] [stderr]    Compiling rand_core v0.6.4
[INFO] [stderr]    Compiling rand_chacha v0.3.1
[INFO] [stderr]    Compiling rand v0.8.5
[INFO] [stderr]    Compiling async-rustbus v0.2.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 3.13s
[INFO] running `Command { std: "docker" "inspect" "d1e72924110a5a1e3ecfbfe0c4a972b37325235673b2dcbe15f66cf2c1e6cb16", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "d1e72924110a5a1e3ecfbfe0c4a972b37325235673b2dcbe15f66cf2c1e6cb16", kill_on_drop: false }`
[INFO] [stdout] d1e72924110a5a1e3ecfbfe0c4a972b37325235673b2dcbe15f66cf2c1e6cb16
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-7-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=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+1.76.0" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] 1c618efb08b4dc6105f127d028c51be8a904822ecba3573260eec04e2e956e05
[INFO] running `Command { std: "docker" "start" "-a" "1c618efb08b4dc6105f127d028c51be8a904822ecba3573260eec04e2e956e05", kill_on_drop: false }`
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 0.04s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/async_rustbus-d0513fd3823ed093)
[INFO] [stdout] 
[INFO] [stdout] running 12 tests
[INFO] [stdout] test routing::tests::matches_is_empty ... ok
[INFO] [stdout] test routing::tests::call_hierarchy_insert ... ok
[INFO] [stdout] test routing::tests::match_order ... ok
[INFO] [stdout] test routing::tests::matches_single ... ok
[INFO] [stdout] test routing::tests::trimming ... ok
[INFO] [stdout] test rustbus_core::message_builder::body::test_marshal_trait ... ok
[INFO] [stdout] test rustbus_core::path::tests::test_objectpath_borrow_path ... ok
[INFO] [stdout] test rustbus_core::path::tests::test_objectpathbuf_borrow_objectpath ... ok
[INFO] [stdout] test rustbus_core::path::tests::test_push ... ok
[INFO] [stdout] test utils::tests::align_num_0_1024 ... ok
[INFO] [stdout] test rustbus_core::message_builder::body::tests::test_rb_validate_signature ... ok
[INFO] [stdout] test rustbus_core::message_builder::body::tests::test_validate_sig_str ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 12 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 3.51s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/bench.rs (/opt/rustwide/target/debug/deps/bench-85302dac254b408d)
[INFO] [stdout] 
[INFO] [stdout] running 7 tests
[INFO] [stdout] test bench_32 ... FAILED
[INFO] [stdout] test bench_1kb ... FAILED
[INFO] [stdout] test bench_empty ... FAILED
[INFO] [stdout] test bench_1mb ... FAILED
[INFO] [stdout] test bench_4mb ... FAILED
[INFO] [stdout] test bench_random ... FAILED
[INFO] [stdout] test marshalling ... ok
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout] 
[INFO] [stdout] ---- bench_32 stdout ----
[INFO] [stdout] Error: Io(Custom { kind: NotFound, error: "No DBus session in environment." })
[INFO] [stdout] 
[INFO] [stdout] ---- bench_1kb stdout ----
[INFO] [stdout] Error: Io(Custom { kind: NotFound, error: "No DBus session in environment." })
[INFO] [stdout] 
[INFO] [stdout] ---- bench_empty stdout ----
[INFO] [stdout] Error: Io(Custom { kind: NotFound, error: "No DBus session in environment." })
[INFO] [stdout] 
[INFO] [stdout] ---- bench_1mb stdout ----
[INFO] [stdout] Error: Io(Custom { kind: NotFound, error: "No DBus session in environment." })
[INFO] [stdout] 
[INFO] [stdout] ---- bench_4mb stdout ----
[INFO] [stdout] Error: Io(Custom { kind: NotFound, error: "No DBus session in environment." })
[INFO] [stdout] 
[INFO] [stdout] ---- bench_random stdout ----
[INFO] [stdout] Error: Io(Custom { kind: NotFound, error: "No DBus session in environment." })
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout]     bench_1kb
[INFO] [stdout]     bench_1mb
[INFO] [stdout]     bench_32
[INFO] [stdout]     bench_4mb
[INFO] [stdout]     bench_empty
[INFO] [stdout]     bench_random
[INFO] [stdout] 
[INFO] [stdout] test result: FAILED. 1 passed; 6 failed; 0 ignored; 0 measured; 0 filtered out; finished in 21.04s
[INFO] [stdout] 
[INFO] [stderr] error: test failed, to rerun pass `--test bench`
[INFO] running `Command { std: "docker" "inspect" "1c618efb08b4dc6105f127d028c51be8a904822ecba3573260eec04e2e956e05", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "1c618efb08b4dc6105f127d028c51be8a904822ecba3573260eec04e2e956e05", kill_on_drop: false }`
[INFO] [stdout] 1c618efb08b4dc6105f127d028c51be8a904822ecba3573260eec04e2e956e05
