[INFO] fetching crate substrate-wasmtime-profiling 0.16.0-threadsafe.4... [INFO] testing substrate-wasmtime-profiling-0.16.0-threadsafe.4 against master#404c8471aba60c2d837fa728e7c729a0f52d5830 for pr-87041-1 [INFO] extracting crate substrate-wasmtime-profiling 0.16.0-threadsafe.4 into /workspace/builds/worker-118/source [INFO] validating manifest of crates.io crate substrate-wasmtime-profiling 0.16.0-threadsafe.4 on toolchain 404c8471aba60c2d837fa728e7c729a0f52d5830 [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+404c8471aba60c2d837fa728e7c729a0f52d5830" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking crates.io crate substrate-wasmtime-profiling 0.16.0-threadsafe.4 [INFO] finished tweaking crates.io crate substrate-wasmtime-profiling 0.16.0-threadsafe.4 [INFO] tweaked toml for crates.io crate substrate-wasmtime-profiling 0.16.0-threadsafe.4 written to /workspace/builds/worker-118/source/Cargo.toml [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+404c8471aba60c2d837fa728e7c729a0f52d5830" "generate-lockfile" "--manifest-path" "Cargo.toml" "-Zno-index-update", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+404c8471aba60c2d837fa728e7c729a0f52d5830" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/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:a429bb59b7a3b4e7270a4b4c243bb115fc561d8f62ec34ef63a0a36cabf65dfd" "/opt/rustwide/cargo-home/bin/cargo" "+404c8471aba60c2d837fa728e7c729a0f52d5830" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] c2e0e5497d9dcf116effde11d9c52ad9c9dd75162aa78c78883e4ea30d80bedd [INFO] running `Command { std: "docker" "start" "-a" "c2e0e5497d9dcf116effde11d9c52ad9c9dd75162aa78c78883e4ea30d80bedd", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "c2e0e5497d9dcf116effde11d9c52ad9c9dd75162aa78c78883e4ea30d80bedd", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "c2e0e5497d9dcf116effde11d9c52ad9c9dd75162aa78c78883e4ea30d80bedd", kill_on_drop: false }` [INFO] [stdout] c2e0e5497d9dcf116effde11d9c52ad9c9dd75162aa78c78883e4ea30d80bedd [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/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" "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:a429bb59b7a3b4e7270a4b4c243bb115fc561d8f62ec34ef63a0a36cabf65dfd" "/opt/rustwide/cargo-home/bin/cargo" "+404c8471aba60c2d837fa728e7c729a0f52d5830" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] db359c6018f7bc4c8e0601ed8d9f8da6e6b1942255160849ffaef67aa9573333 [INFO] running `Command { std: "docker" "start" "-a" "db359c6018f7bc4c8e0601ed8d9f8da6e6b1942255160849ffaef67aa9573333", kill_on_drop: false }` [INFO] [stderr] Compiling libc v0.2.112 [INFO] [stderr] Compiling autocfg v1.0.1 [INFO] [stderr] Compiling proc-macro2 v1.0.34 [INFO] [stderr] Compiling unicode-xid v0.2.2 [INFO] [stderr] Compiling syn v1.0.82 [INFO] [stderr] Compiling cfg-if v1.0.0 [INFO] [stderr] Compiling serde_derive v1.0.131 [INFO] [stderr] Compiling serde v1.0.131 [INFO] [stderr] Compiling either v1.6.1 [INFO] [stderr] Compiling crossbeam-utils v0.8.5 [INFO] [stderr] Compiling lazy_static v1.4.0 [INFO] [stderr] Compiling typenum v1.14.0 [INFO] [stderr] Compiling cranelift-codegen-shared v0.63.0 [INFO] [stderr] Compiling byteorder v1.4.3 [INFO] [stderr] Compiling glob v0.3.0 [INFO] [stderr] Compiling crossbeam-epoch v0.9.5 [INFO] [stderr] Compiling target-lexicon v0.10.0 [INFO] [stderr] Compiling rustc-hash v1.1.0 [INFO] [stderr] Compiling rayon-core v1.9.1 [INFO] [stderr] Compiling byte-tools v0.3.1 [INFO] [stderr] Compiling zstd-safe v2.0.6+zstd.1.4.7 [INFO] [stderr] Compiling anyhow v1.0.51 [INFO] [stderr] Compiling wasmparser v0.51.4 [INFO] [stderr] Compiling fake-simd v0.1.2 [INFO] [stderr] Compiling opaque-debug v0.2.3 [INFO] [stderr] Compiling wasmtime-environ v0.16.0 [INFO] [stderr] Compiling gimli v0.26.1 [INFO] [stderr] Compiling base64 v0.12.3 [INFO] [stderr] Compiling more-asserts v0.2.2 [INFO] [stderr] Compiling rustc-demangle v0.1.21 [INFO] [stderr] Compiling bitflags v1.3.2 [INFO] [stderr] Compiling object v0.27.1 [INFO] [stderr] Compiling log v0.4.14 [INFO] [stderr] Compiling block-padding v0.1.5 [INFO] [stderr] Compiling itertools v0.9.0 [INFO] [stderr] Compiling regalloc v0.0.21 [INFO] [stderr] Compiling indexmap v1.7.0 [INFO] [stderr] Compiling memoffset v0.6.5 [INFO] [stderr] Compiling miniz_oxide v0.4.4 [INFO] [stderr] Compiling rayon v1.5.1 [INFO] [stderr] Compiling memoffset v0.5.6 [INFO] [stderr] Compiling crossbeam-channel v0.5.1 [INFO] [stderr] Compiling quote v1.0.10 [INFO] [stderr] Compiling crossbeam-deque v0.8.1 [INFO] [stderr] Compiling jobserver v0.1.24 [INFO] [stderr] Compiling num_cpus v1.13.0 [INFO] [stderr] Compiling atty v0.2.14 [INFO] [stderr] Compiling dirs-sys v0.3.6 [INFO] [stderr] Compiling errno v0.2.8 [INFO] [stderr] Compiling region v2.2.0 [INFO] [stderr] Compiling gimli v0.20.0 [INFO] [stderr] Compiling env_logger v0.7.1 [INFO] [stderr] Compiling directories v2.0.2 [INFO] [stderr] Compiling cc v1.0.72 [INFO] [stderr] Compiling generic-array v0.12.4 [INFO] [stderr] Compiling file-per-thread-logger v0.1.4 [INFO] [stderr] Compiling block-buffer v0.7.3 [INFO] [stderr] Compiling digest v0.8.1 [INFO] [stderr] Compiling sha2 v0.8.2 [INFO] [stderr] Compiling zstd-sys v1.4.18+zstd.1.4.7 [INFO] [stderr] Compiling backtrace v0.3.63 [INFO] [stderr] Compiling substrate-wasmtime-runtime v0.16.0-threadsafe.4 [INFO] [stderr] Compiling addr2line v0.17.0 [INFO] [stderr] Compiling thiserror-impl v1.0.30 [INFO] [stderr] Compiling thiserror v1.0.30 [INFO] [stderr] Compiling cranelift-entity v0.63.0 [INFO] [stderr] Compiling toml v0.5.8 [INFO] [stderr] Compiling bincode v1.3.3 [INFO] [stderr] Compiling cranelift-codegen-meta v0.63.0 [INFO] [stderr] Compiling cranelift-bforest v0.63.0 [INFO] [stderr] Compiling cranelift-codegen v0.63.0 [INFO] [stderr] Compiling zstd v0.5.4+zstd.1.4.7 [INFO] [stderr] Compiling cranelift-frontend v0.63.0 [INFO] [stderr] Compiling cranelift-wasm v0.63.0 [INFO] [stderr] Compiling substrate-wasmtime-profiling v0.16.0-threadsafe.4 (/opt/rustwide/workdir) [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 1m 47s [INFO] running `Command { std: "docker" "inspect" "db359c6018f7bc4c8e0601ed8d9f8da6e6b1942255160849ffaef67aa9573333", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "db359c6018f7bc4c8e0601ed8d9f8da6e6b1942255160849ffaef67aa9573333", kill_on_drop: false }` [INFO] [stdout] db359c6018f7bc4c8e0601ed8d9f8da6e6b1942255160849ffaef67aa9573333 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/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" "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:a429bb59b7a3b4e7270a4b4c243bb115fc561d8f62ec34ef63a0a36cabf65dfd" "/opt/rustwide/cargo-home/bin/cargo" "+404c8471aba60c2d837fa728e7c729a0f52d5830" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] f657dda503590f967f23fd9567eed537d215a6d4a39f1481123baea3ab197704 [INFO] running `Command { std: "docker" "start" "-a" "f657dda503590f967f23fd9567eed537d215a6d4a39f1481123baea3ab197704", kill_on_drop: false }` [INFO] [stderr] Compiling substrate-wasmtime-profiling v0.16.0-threadsafe.4 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 1.06s [INFO] running `Command { std: "docker" "inspect" "f657dda503590f967f23fd9567eed537d215a6d4a39f1481123baea3ab197704", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "f657dda503590f967f23fd9567eed537d215a6d4a39f1481123baea3ab197704", kill_on_drop: false }` [INFO] [stdout] f657dda503590f967f23fd9567eed537d215a6d4a39f1481123baea3ab197704 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-118/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" "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:a429bb59b7a3b4e7270a4b4c243bb115fc561d8f62ec34ef63a0a36cabf65dfd" "/opt/rustwide/cargo-home/bin/cargo" "+404c8471aba60c2d837fa728e7c729a0f52d5830" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 59015a27279137c74f42c42259ba1f7353282a3a6ea21a81bbea613bdeb253f3 [INFO] running `Command { std: "docker" "start" "-a" "59015a27279137c74f42c42259ba1f7353282a3a6ea21a81bbea613bdeb253f3", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.57s [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/substrate_wasmtime_profiling-4f5f912a95f189b1) [INFO] [stdout] [INFO] [stdout] running 0 tests [INFO] [stdout] [INFO] [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s [INFO] [stdout] [INFO] [stderr] Doc-tests substrate-wasmtime-profiling [INFO] [stdout] [INFO] [stdout] running 0 tests [INFO] [stdout] [INFO] [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s [INFO] [stdout] [INFO] running `Command { std: "docker" "inspect" "59015a27279137c74f42c42259ba1f7353282a3a6ea21a81bbea613bdeb253f3", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "59015a27279137c74f42c42259ba1f7353282a3a6ea21a81bbea613bdeb253f3", kill_on_drop: false }` [INFO] [stdout] 59015a27279137c74f42c42259ba1f7353282a3a6ea21a81bbea613bdeb253f3