[INFO] cloning repository https://github.com/LebranceBW/KvStore [INFO] running `Command { std: "git" "-c" "credential.helper=" "-c" "credential.helper=/workspace/cargo-home/bin/git-credential-null" "clone" "--bare" "https://github.com/LebranceBW/KvStore" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FLebranceBW%2FKvStore", kill_on_drop: false }` [INFO] [stderr] Cloning into bare repository '/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FLebranceBW%2FKvStore'... [INFO] running `Command { std: "git" "rev-parse" "HEAD", kill_on_drop: false }` [INFO] [stdout] ef2729f70bea8a962e1da6f6c6bf0359ae0999bb [INFO] testing LebranceBW/KvStore against try#ecabaf78506b7a4668d42dc20268c086b93f0fad for pr-87041 [INFO] running `Command { std: "git" "clone" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FLebranceBW%2FKvStore" "/workspace/builds/worker-0/source", kill_on_drop: false }` [INFO] [stderr] Cloning into '/workspace/builds/worker-0/source'... [INFO] [stderr] done. [INFO] validating manifest of git repo https://github.com/LebranceBW/KvStore on toolchain ecabaf78506b7a4668d42dc20268c086b93f0fad [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking git repo https://github.com/LebranceBW/KvStore [INFO] finished tweaking git repo https://github.com/LebranceBW/KvStore [INFO] tweaked toml for git repo https://github.com/LebranceBW/KvStore written to /workspace/builds/worker-0/source/Cargo.toml [INFO] crate git repo https://github.com/LebranceBW/KvStore already has a lockfile, it will not be regenerated [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Downloading crates ... [INFO] [stderr] Downloaded crossbeam v0.8.1 [INFO] [stderr] Downloaded crossbeam-queue v0.3.2 [INFO] [stderr] Downloaded assert_cmd v0.11.1 [INFO] [stderr] Downloaded owned-alloc v0.2.0 [INFO] [stderr] Downloaded escargot v0.4.0 [INFO] [stderr] Downloaded normalize-line-endings v0.3.0 [INFO] [stderr] Downloaded fragile v1.0.0 [INFO] [stderr] Downloaded panic-control v0.1.4 [INFO] [stderr] Downloaded mockall v0.9.1 [INFO] [stderr] Downloaded difference v2.0.0 [INFO] [stderr] Downloaded sled v0.34.6 [INFO] [stderr] Downloaded predicates v1.0.8 [INFO] [stderr] Downloaded colored v1.9.3 [INFO] [stderr] Downloaded predicates-core v1.0.2 [INFO] [stderr] Downloaded lockfree v0.5.1 [INFO] [stderr] Downloaded downcast v0.10.0 [INFO] [stderr] Downloaded mockall_derive v0.9.1 [INFO] [stderr] Downloaded treeline v0.1.0 [INFO] [stderr] Downloaded predicates-tree v1.0.2 [INFO] [stderr] Downloaded float-cmp v0.8.0 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/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:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] [stdout] e0c7ae104ca7579116fde751df80e09749593a349f0c62fba261ed29c6a720a6 [INFO] running `Command { std: "docker" "start" "-a" "e0c7ae104ca7579116fde751df80e09749593a349f0c62fba261ed29c6a720a6", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "e0c7ae104ca7579116fde751df80e09749593a349f0c62fba261ed29c6a720a6", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "e0c7ae104ca7579116fde751df80e09749593a349f0c62fba261ed29c6a720a6", kill_on_drop: false }` [INFO] [stdout] e0c7ae104ca7579116fde751df80e09749593a349f0c62fba261ed29c6a720a6 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/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:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] bb2ab53cb265c1c13051ba6cfea596f1ffaf361172b89cbdd4bcb6b9d8c9e334 [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] running `Command { std: "docker" "start" "-a" "bb2ab53cb265c1c13051ba6cfea596f1ffaf361172b89cbdd4bcb6b9d8c9e334", kill_on_drop: false }` [INFO] [stderr] Compiling autocfg v1.0.1 [INFO] [stderr] Compiling cfg-if v1.0.0 [INFO] [stderr] Compiling libc v0.2.98 [INFO] [stderr] Compiling proc-macro2 v1.0.27 [INFO] [stderr] Compiling lazy_static v1.4.0 [INFO] [stderr] Compiling unicode-xid v0.2.2 [INFO] [stderr] Compiling crossbeam-utils v0.8.5 [INFO] [stderr] Compiling version_check v0.9.3 [INFO] [stderr] Compiling scopeguard v1.1.0 [INFO] [stderr] Compiling crossbeam-epoch v0.9.5 [INFO] [stderr] Compiling memchr v2.4.0 [INFO] [stderr] Compiling serde_derive v1.0.126 [INFO] [stderr] Compiling rayon-core v1.9.1 [INFO] [stderr] Compiling log v0.4.14 [INFO] [stderr] Compiling bitflags v1.2.1 [INFO] [stderr] Compiling unicode-width v0.1.8 [INFO] [stderr] Compiling smallvec v1.6.1 [INFO] [stderr] Compiling ryu v1.0.5 [INFO] [stderr] Compiling crc32fast v1.2.1 [INFO] [stderr] Compiling regex-syntax v0.6.25 [INFO] [stderr] Compiling strsim v0.8.0 [INFO] [stderr] Compiling vec_map v0.8.2 [INFO] [stderr] Compiling byteorder v1.4.3 [INFO] [stderr] Compiling serde_json v1.0.64 [INFO] [stderr] Compiling ansi_term v0.11.0 [INFO] [stderr] Compiling downcast v0.10.0 [INFO] [stderr] Compiling fragile v1.0.0 [INFO] [stderr] Compiling itoa v0.4.7 [INFO] [stderr] Compiling either v1.6.1 [INFO] [stderr] Compiling instant v0.1.9 [INFO] [stderr] Compiling lock_api v0.4.4 [INFO] [stderr] Compiling textwrap v0.11.0 [INFO] [stderr] Compiling memoffset v0.6.4 [INFO] [stderr] Compiling num-traits v0.2.14 [INFO] [stderr] Compiling num-integer v0.1.44 [INFO] [stderr] Compiling rayon v1.5.1 [INFO] [stderr] Compiling proc-macro-error-attr v1.0.4 [INFO] [stderr] Compiling proc-macro-error v1.0.4 [INFO] [stderr] Compiling fxhash v0.2.1 [INFO] [stderr] Compiling crossbeam-channel v0.5.1 [INFO] [stderr] Compiling crossbeam-queue v0.3.2 [INFO] [stderr] Compiling quote v1.0.9 [INFO] [stderr] Compiling aho-corasick v0.7.18 [INFO] [stderr] Compiling atty v0.2.14 [INFO] [stderr] Compiling time v0.1.43 [INFO] [stderr] Compiling num_cpus v1.13.0 [INFO] [stderr] Compiling parking_lot_core v0.8.3 [INFO] [stderr] Compiling fs2 v0.4.3 [INFO] [stderr] Compiling syn v1.0.73 [INFO] [stderr] Compiling colored v1.9.3 [INFO] [stderr] Compiling clap v2.33.3 [INFO] [stderr] Compiling crossbeam-deque v0.8.0 [INFO] [stderr] Compiling parking_lot v0.11.1 [INFO] [stderr] Compiling crossbeam v0.8.1 [INFO] [stderr] Compiling sled v0.34.6 [INFO] [stderr] Compiling float-cmp v0.8.0 [INFO] [stderr] Compiling regex v1.5.4 [INFO] [stderr] Compiling chrono v0.4.19 [INFO] [stderr] Compiling predicates v1.0.8 [INFO] [stderr] Compiling simple_logger v1.11.0 [INFO] [stderr] Compiling structopt-derive v0.4.15 [INFO] [stderr] Compiling mockall_derive v0.9.1 [INFO] [stderr] Compiling structopt v0.3.22 [INFO] [stderr] Compiling mockall v0.9.1 [INFO] [stderr] Compiling serde v1.0.126 [INFO] [stderr] Compiling kvs v0.1.0 (/opt/rustwide/workdir) [INFO] [stdout] warning: unused import: `Mutex` [INFO] [stdout] --> src/kvstore.rs:8:22 [INFO] [stdout] | [INFO] [stdout] 8 | use std::sync::{Arc, Mutex, RwLock}; [INFO] [stdout] | ^^^^^ [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_imports)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `pos` [INFO] [stdout] --> src/engine/kvstore/file_operators.rs:14:33 [INFO] [stdout] | [INFO] [stdout] 14 | pub fn query_command(&self, pos: FileOffset) -> Result { [INFO] [stdout] | ^^^ help: if this is intentional, prefix it with an underscore: `_pos` [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_variables)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `command` [INFO] [stdout] --> src/engine/kvstore/file_operators.rs:24:34 [INFO] [stdout] | [INFO] [stdout] 24 | pub fn insert_command(&self, command: Command) -> Result { [INFO] [stdout] | ^^^^^^^ help: if this is intentional, prefix it with an underscore: `_command` [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `dir` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:30:17 [INFO] [stdout] | [INFO] [stdout] 30 | pub fn open(dir: impl Into) -> Self { [INFO] [stdout] | ^^^ help: if this is intentional, prefix it with an underscore: `_dir` [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `pos` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:85:55 [INFO] [stdout] | [INFO] [stdout] 85 | self.writer.insert_command(command).and_then(|pos| { [INFO] [stdout] | ^^^ help: if this is intentional, prefix it with an underscore: `_pos` [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: variable does not need to be mutable [INFO] [stdout] --> src/kvstore.rs:261:13 [INFO] [stdout] | [INFO] [stdout] 261 | let mut yolk = self.yolk.write().unwrap(); [INFO] [stdout] | ----^^^^ [INFO] [stdout] | | [INFO] [stdout] | help: remove this `mut` [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_mut)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: associated function is never used: `open` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:30:12 [INFO] [stdout] | [INFO] [stdout] 30 | pub fn open(dir: impl Into) -> Self { [INFO] [stdout] | ^^^^ [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(dead_code)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: associated function is never used: `compaction` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:34:8 [INFO] [stdout] | [INFO] [stdout] 34 | fn compaction(&mut self) -> Result<()> { [INFO] [stdout] | ^^^^^^^^^^ [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: struct is never constructed: `MockKvsEngine` [INFO] [stdout] --> src/engine/mod.rs:21:12 [INFO] [stdout] | [INFO] [stdout] 21 | pub struct MockKvsEngine; [INFO] [stdout] | ^^^^^^^^^^^^^ [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: 9 warnings emitted [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused imports: `NaiveThreadPool`, `SharedQueueThreadPool` [INFO] [stdout] --> src/bin/kvs-server.rs:12:24 [INFO] [stdout] | [INFO] [stdout] 12 | use kvs::thread_pool::{NaiveThreadPool, RayonThreadPool, SharedQueueThreadPool, ThreadPool}; [INFO] [stdout] | ^^^^^^^^^^^^^^^ ^^^^^^^^^^^^^^^^^^^^^ [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_imports)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: 1 warning emitted [INFO] [stdout] [INFO] [stdout] [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 1m 13s [INFO] running `Command { std: "docker" "inspect" "bb2ab53cb265c1c13051ba6cfea596f1ffaf361172b89cbdd4bcb6b9d8c9e334", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "bb2ab53cb265c1c13051ba6cfea596f1ffaf361172b89cbdd4bcb6b9d8c9e334", kill_on_drop: false }` [INFO] [stdout] bb2ab53cb265c1c13051ba6cfea596f1ffaf361172b89cbdd4bcb6b9d8c9e334 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/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:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] [stdout] a15a58f922178243e15aa425158cd299365ba4b26eeb5b421a583890da3145f8 [INFO] running `Command { std: "docker" "start" "-a" "a15a58f922178243e15aa425158cd299365ba4b26eeb5b421a583890da3145f8", 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] Compiling semver v1.0.3 [INFO] [stderr] Compiling regex-automata v0.1.10 [INFO] [stderr] Compiling ppv-lite86 v0.2.10 [INFO] [stderr] Compiling plotters-backend v0.3.2 [INFO] [stderr] Compiling same-file v1.0.6 [INFO] [stderr] Compiling remove_dir_all v0.5.3 [INFO] [stderr] Compiling panic-control v0.1.4 [INFO] [stderr] Compiling itertools v0.9.0 [INFO] [stderr] Compiling itertools v0.10.1 [INFO] [stderr] Compiling getrandom v0.2.3 [INFO] [stderr] Compiling csv-core v0.1.10 [INFO] [stderr] Compiling serde_cbor v0.11.1 [INFO] [stderr] Compiling escargot v0.4.0 [INFO] [stderr] Compiling tinytemplate v1.2.1 [INFO] [stdout] warning: unused import: `Mutex` [INFO] [stdout] --> src/kvstore.rs:8:22 [INFO] [stdout] | [INFO] [stdout] 8 | use std::sync::{Arc, Mutex, RwLock}; [INFO] [stdout] | ^^^^^ [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_imports)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `pos` [INFO] [stdout] --> src/engine/kvstore/file_operators.rs:14:33 [INFO] [stdout] | [INFO] [stdout] 14 | pub fn query_command(&self, pos: FileOffset) -> Result { [INFO] [stdout] | ^^^ help: if this is intentional, prefix it with an underscore: `_pos` [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_variables)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `command` [INFO] [stdout] --> src/engine/kvstore/file_operators.rs:24:34 [INFO] [stdout] | [INFO] [stdout] 24 | pub fn insert_command(&self, command: Command) -> Result { [INFO] [stdout] | ^^^^^^^ help: if this is intentional, prefix it with an underscore: `_command` [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `dir` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:30:17 [INFO] [stdout] | [INFO] [stdout] 30 | pub fn open(dir: impl Into) -> Self { [INFO] [stdout] | ^^^ help: if this is intentional, prefix it with an underscore: `_dir` [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused variable: `pos` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:85:55 [INFO] [stdout] | [INFO] [stdout] 85 | self.writer.insert_command(command).and_then(|pos| { [INFO] [stdout] | ^^^ help: if this is intentional, prefix it with an underscore: `_pos` [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: variable does not need to be mutable [INFO] [stdout] --> src/kvstore.rs:261:13 [INFO] [stdout] | [INFO] [stdout] 261 | let mut yolk = self.yolk.write().unwrap(); [INFO] [stdout] | ----^^^^ [INFO] [stdout] | | [INFO] [stdout] | help: remove this `mut` [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_mut)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: associated function is never used: `open` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:30:12 [INFO] [stdout] | [INFO] [stdout] 30 | pub fn open(dir: impl Into) -> Self { [INFO] [stdout] | ^^^^ [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(dead_code)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: associated function is never used: `compaction` [INFO] [stdout] --> src/engine/kvstore/kvstore.rs:34:8 [INFO] [stdout] | [INFO] [stdout] 34 | fn compaction(&mut self) -> Result<()> { [INFO] [stdout] | ^^^^^^^^^^ [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: struct is never constructed: `MockKvsEngine` [INFO] [stdout] --> src/engine/mod.rs:21:12 [INFO] [stdout] | [INFO] [stdout] 21 | pub struct MockKvsEngine; [INFO] [stdout] | ^^^^^^^^^^^^^ [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: 9 warnings emitted [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: unused imports: `NaiveThreadPool`, `SharedQueueThreadPool` [INFO] [stdout] --> src/bin/kvs-server.rs:12:24 [INFO] [stdout] | [INFO] [stdout] 12 | use kvs::thread_pool::{NaiveThreadPool, RayonThreadPool, SharedQueueThreadPool, ThreadPool}; [INFO] [stdout] | ^^^^^^^^^^^^^^^ ^^^^^^^^^^^^^^^^^^^^^ [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_imports)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: 1 warning emitted [INFO] [stdout] [INFO] [stdout] [INFO] [stderr] Compiling walkdir v2.3.2 [INFO] [stderr] Compiling rand_core v0.6.3 [INFO] [stderr] Compiling bstr v0.2.16 [INFO] [stderr] Compiling plotters-svg v0.3.1 [INFO] [stderr] Compiling rand_chacha v0.3.1 [INFO] [stderr] Compiling plotters v0.3.1 [INFO] [stderr] Compiling rand v0.8.4 [INFO] [stderr] Compiling rustc_version v0.4.0 [INFO] [stderr] Compiling assert_cmd v0.11.1 [INFO] [stderr] Compiling csv v1.1.6 [INFO] [stderr] Compiling cast v0.2.7 [INFO] [stderr] Compiling tempfile v3.2.0 [INFO] [stderr] Compiling criterion-plot v0.4.3 [INFO] [stderr] Compiling criterion v0.3.4 [INFO] [stderr] Compiling kvs v0.1.0 (/opt/rustwide/workdir) [INFO] [stdout] warning: unused imports: `NaiveThreadPool`, `SharedQueueThreadPool` [INFO] [stdout] --> src/bin/kvs-server.rs:12:24 [INFO] [stdout] | [INFO] [stdout] 12 | use kvs::thread_pool::{NaiveThreadPool, RayonThreadPool, SharedQueueThreadPool, ThreadPool}; [INFO] [stdout] | ^^^^^^^^^^^^^^^ ^^^^^^^^^^^^^^^^^^^^^ [INFO] [stdout] | [INFO] [stdout] = note: `#[warn(unused_imports)]` on by default [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] warning: 1 warning emitted [INFO] [stdout] [INFO] [stdout] [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 49.90s [INFO] running `Command { std: "docker" "inspect" "a15a58f922178243e15aa425158cd299365ba4b26eeb5b421a583890da3145f8", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "a15a58f922178243e15aa425158cd299365ba4b26eeb5b421a583890da3145f8", kill_on_drop: false }` [INFO] [stdout] a15a58f922178243e15aa425158cd299365ba4b26eeb5b421a583890da3145f8 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-0/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:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "test" "--frozen", kill_on_drop: false }` [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] [stdout] 7be637aaa6714831f85f0bf123407eb3e266829e2c0a935c0d2b373273bf97e8 [INFO] running `Command { std: "docker" "start" "-a" "7be637aaa6714831f85f0bf123407eb3e266829e2c0a935c0d2b373273bf97e8", kill_on_drop: false }` [INFO] [stderr] warning: unused import: `Mutex` [INFO] [stderr] --> src/kvstore.rs:8:22 [INFO] [stderr] | [INFO] [stderr] 8 | use std::sync::{Arc, Mutex, RwLock}; [INFO] [stderr] | ^^^^^ [INFO] [stderr] | [INFO] [stderr] = note: `#[warn(unused_imports)]` on by default [INFO] [stderr] [INFO] [stderr] warning: unused variable: `pos` [INFO] [stderr] --> src/engine/kvstore/file_operators.rs:14:33 [INFO] [stderr] | [INFO] [stderr] 14 | pub fn query_command(&self, pos: FileOffset) -> Result { [INFO] [stderr] | ^^^ help: if this is intentional, prefix it with an underscore: `_pos` [INFO] [stderr] | [INFO] [stderr] = note: `#[warn(unused_variables)]` on by default [INFO] [stderr] [INFO] [stderr] warning: unused variable: `command` [INFO] [stderr] --> src/engine/kvstore/file_operators.rs:24:34 [INFO] [stderr] | [INFO] [stderr] 24 | pub fn insert_command(&self, command: Command) -> Result { [INFO] [stderr] | ^^^^^^^ help: if this is intentional, prefix it with an underscore: `_command` [INFO] [stderr] [INFO] [stderr] warning: unused variable: `dir` [INFO] [stderr] --> src/engine/kvstore/kvstore.rs:30:17 [INFO] [stderr] | [INFO] [stderr] 30 | pub fn open(dir: impl Into) -> Self { [INFO] [stderr] | ^^^ help: if this is intentional, prefix it with an underscore: `_dir` [INFO] [stderr] [INFO] [stderr] warning: unused variable: `pos` [INFO] [stderr] --> src/engine/kvstore/kvstore.rs:85:55 [INFO] [stderr] | [INFO] [stderr] 85 | self.writer.insert_command(command).and_then(|pos| { [INFO] [stderr] | ^^^ help: if this is intentional, prefix it with an underscore: `_pos` [INFO] [stderr] [INFO] [stderr] warning: variable does not need to be mutable [INFO] [stderr] --> src/kvstore.rs:261:13 [INFO] [stderr] | [INFO] [stderr] 261 | let mut yolk = self.yolk.write().unwrap(); [INFO] [stderr] | ----^^^^ [INFO] [stderr] | | [INFO] [stderr] | help: remove this `mut` [INFO] [stderr] | [INFO] [stderr] = note: `#[warn(unused_mut)]` on by default [INFO] [stderr] [INFO] [stderr] warning: associated function is never used: `open` [INFO] [stderr] --> src/engine/kvstore/kvstore.rs:30:12 [INFO] [stderr] | [INFO] [stderr] 30 | pub fn open(dir: impl Into) -> Self { [INFO] [stderr] | ^^^^ [INFO] [stderr] | [INFO] [stderr] = note: `#[warn(dead_code)]` on by default [INFO] [stderr] [INFO] [stderr] warning: associated function is never used: `compaction` [INFO] [stderr] --> src/engine/kvstore/kvstore.rs:34:8 [INFO] [stderr] | [INFO] [stderr] 34 | fn compaction(&mut self) -> Result<()> { [INFO] [stderr] | ^^^^^^^^^^ [INFO] [stderr] [INFO] [stderr] warning: struct is never constructed: `MockKvsEngine` [INFO] [stderr] --> src/engine/mod.rs:21:12 [INFO] [stderr] | [INFO] [stderr] 21 | pub struct MockKvsEngine; [INFO] [stderr] | ^^^^^^^^^^^^^ [INFO] [stderr] [INFO] [stderr] warning: 9 warnings emitted [INFO] [stderr] [INFO] [stderr] warning: unused imports: `NaiveThreadPool`, `SharedQueueThreadPool` [INFO] [stderr] --> src/bin/kvs-server.rs:12:24 [INFO] [stderr] | [INFO] [stderr] 12 | use kvs::thread_pool::{NaiveThreadPool, RayonThreadPool, SharedQueueThreadPool, ThreadPool}; [INFO] [stderr] | ^^^^^^^^^^^^^^^ ^^^^^^^^^^^^^^^^^^^^^ [INFO] [stderr] | [INFO] [stderr] = note: `#[warn(unused_imports)]` on by default [INFO] [stderr] [INFO] [stderr] warning: 1 warning emitted [INFO] [stderr] [INFO] [stderr] warning: unused imports: `NaiveThreadPool`, `SharedQueueThreadPool` [INFO] [stderr] --> src/bin/kvs-server.rs:12:24 [INFO] [stderr] | [INFO] [stderr] 12 | use kvs::thread_pool::{NaiveThreadPool, RayonThreadPool, SharedQueueThreadPool, ThreadPool}; [INFO] [stderr] | ^^^^^^^^^^^^^^^ ^^^^^^^^^^^^^^^^^^^^^ [INFO] [stderr] | [INFO] [stderr] = note: `#[warn(unused_imports)]` on by default [INFO] [stderr] [INFO] [stderr] warning: 1 warning emitted [INFO] [stderr] [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.15s [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/kvs-28d2dd0ca44dff25) [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] Running unittests (/opt/rustwide/target/debug/deps/kvs_client-81d76b339f075d87) [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] Running unittests (/opt/rustwide/target/debug/deps/kvs_server-5ebdfaea864f4dad) [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] Running tests/cli.rs (/opt/rustwide/target/debug/deps/cli-c40212a7cc8549e7) [INFO] [stdout] [INFO] [stdout] running 11 tests [INFO] [stdout] test client_cli_invalid_subcommand ... ok [INFO] [stdout] test client_cli_version ... ok [INFO] [stdout] test server_cli_version ... ok [INFO] [stdout] test client_cli_no_args ... ok [INFO] [stdout] 2021-07-17 23:48:43,158 INFO [kvs_server] Listened at 127.0.0.1:4004, powered by kvs, version: 0.1.0 [INFO] [stdout] 2021-07-17 23:48:43,156 INFO [kvs_server] Listened at 127.0.0.1:4002, powered by sled, version: 0.1.0 [INFO] [stdout] 2021-07-17 23:48:43,152 INFO [kvs_server] Listened at 127.0.0.1:4005, powered by sled, version: 0.1.0 [INFO] [stdout] test client_cli_invalid_rm ... ok [INFO] [stdout] test client_cli_invalid_set ... ok [INFO] [stdout] test client_cli_invalid_get ... ok [INFO] [stdout] 2021-07-17 23:48:43,516 DEBUG [sled::pagecache::snapshot] no previous snapshot found [INFO] [stdout] 2021-07-17 23:48:43,516 DEBUG [sled::pagecache::iterator] ordering before clearing tears: {}, max_header_stable_lsn: 0 [INFO] [stdout] 2021-07-17 23:48:43,516 DEBUG [sled::pagecache::iterator] in clean_tail_tears, found missing item in tail: None and we'll scan segments {} above lowest lsn 0 [INFO] [stdout] 2021-07-17 23:48:43,516 DEBUG [sled::pagecache::iterator] unable to load new segment: Io(Custom { kind: Other, error: "no segments remaining to iterate over" }) [INFO] [stdout] 2021-07-17 23:48:43,516 DEBUG [sled::pagecache::iterator] filtering out segments after detected tear at (lsn, lid) -1 [INFO] [stdout] 2021-07-17 23:48:43,516 DEBUG [sled::pagecache::iterator] unable to load new segment: Io(Custom { kind: Other, error: "no segments remaining to iterate over" }) [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::pagecache::segment] SA starting with tip 0 stable -1 free {} [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::pagecache::iobuf] starting log for a totally fresh system [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::pagecache::segment] segment accountant returning offset: 0 for lsn 0 on deck: {} [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::pagecache::iobuf] starting IoBufs with next_lsn: 0 next_lid: 0 [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::pagecache::iobuf] storing lsn 0 in beginning of buffer [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::pagecache] load_snapshot loading pages from 0..0 [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::meta] allocated pid 3 for root of new_tree [95, 95, 115, 108, 101, 100, 95, 95, 100, 101, 102, 97, 117, 108, 116] [INFO] [stdout] 2021-07-17 23:48:43,517 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 0 to 71 [INFO] [stdout] 2021-07-17 23:48:43,521 DEBUG [sled::pagecache::iobuf] wrote lsns 0-70 to disk at offsets 0-70, maxed false complete_len 71 [INFO] [stdout] 2021-07-17 23:48:43,521 DEBUG [sled::pagecache::iobuf] mark_interval(0, 71) [INFO] [stdout] 2021-07-17 23:48:43,521 DEBUG [sled::pagecache::iobuf] new highest interval: 0 - 70 [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::snapshot] no previous snapshot found [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iterator] ordering before clearing tears: {}, max_header_stable_lsn: 0 [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iterator] in clean_tail_tears, found missing item in tail: None and we'll scan segments {} above lowest lsn 0 [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iterator] unable to load new segment: Io(Custom { kind: Other, error: "no segments remaining to iterate over" }) [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iterator] filtering out segments after detected tear at (lsn, lid) -1 [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iterator] unable to load new segment: Io(Custom { kind: Other, error: "no segments remaining to iterate over" }) [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::segment] SA starting with tip 0 stable -1 free {} [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iobuf] starting log for a totally fresh system [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::segment] segment accountant returning offset: 0 for lsn 0 on deck: {} [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iobuf] starting IoBufs with next_lsn: 0 next_lid: 0 [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache::iobuf] storing lsn 0 in beginning of buffer [INFO] [stdout] 2021-07-17 23:48:43,586 DEBUG [sled::pagecache] load_snapshot loading pages from 0..0 [INFO] [stdout] 2021-07-17 23:48:43,587 DEBUG [sled::meta] allocated pid 3 for root of new_tree [95, 95, 115, 108, 101, 100, 95, 95, 100, 101, 102, 97, 117, 108, 116] [INFO] [stdout] 2021-07-17 23:48:43,589 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 0 to 71 [INFO] [stdout] 2021-07-17 23:48:43,598 DEBUG [sled::pagecache::iobuf] wrote lsns 0-70 to disk at offsets 0-70, maxed false complete_len 71 [INFO] [stdout] 2021-07-17 23:48:43,598 DEBUG [sled::pagecache::iobuf] mark_interval(0, 71) [INFO] [stdout] 2021-07-17 23:48:43,598 DEBUG [sled::pagecache::iobuf] new highest interval: 0 - 70 [INFO] [stdout] 2021-07-17 23:48:44,018 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 71 to 96 [INFO] [stdout] 2021-07-17 23:48:44,018 DEBUG [sled::pagecache::iobuf] wrote lsns 71-95 to disk at offsets 71-95, maxed false complete_len 25 [INFO] [stdout] 2021-07-17 23:48:44,018 DEBUG [sled::pagecache::iobuf] mark_interval(71, 25) [INFO] [stdout] 2021-07-17 23:48:44,018 DEBUG [sled::pagecache::iobuf] new highest interval: 71 - 95 [INFO] [stdout] 2021-07-17 23:48:44,089 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 71 to 96 [INFO] [stdout] 2021-07-17 23:48:44,090 DEBUG [sled::pagecache::iobuf] wrote lsns 71-95 to disk at offsets 71-95, maxed false complete_len 25 [INFO] [stdout] 2021-07-17 23:48:44,090 DEBUG [sled::pagecache::iobuf] mark_interval(71, 25) [INFO] [stdout] 2021-07-17 23:48:44,090 DEBUG [sled::pagecache::iobuf] new highest interval: 71 - 95 [INFO] [stdout] 2021-07-17 23:48:44,152 INFO [kvs::server] Accept connection from client: 127.0.0.1:50576 [INFO] [stdout] 2021-07-17 23:48:44,152 INFO [kvs::server] Client: 127.0.0.1:50576 disconnected [INFO] [stdout] 2021-07-17 23:48:44,152 DEBUG [kvs::server] [client->server] {"Set":{"key":"key1","value":"value1"}} [INFO] [stdout] 2021-07-17 23:48:44,152 DEBUG [kvs::server] command: Set { key: "key1", value: "value1" } [INFO] [stdout] 2021-07-17 23:48:44,153 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 96 to 117 [INFO] [stdout] 2021-07-17 23:48:44,153 DEBUG [sled::pagecache::iobuf] wrote lsns 96-116 to disk at offsets 96-116, maxed false complete_len 21 [INFO] [stdout] 2021-07-17 23:48:44,153 DEBUG [sled::pagecache::iobuf] mark_interval(96, 21) [INFO] [stdout] 2021-07-17 23:48:44,153 DEBUG [sled::pagecache::iobuf] new highest interval: 96 - 116 [INFO] [stdout] 2021-07-17 23:48:44,153 DEBUG [sled::pagecache::iobuf] make_stable(116) returning [INFO] [stdout] 2021-07-17 23:48:44,153 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stdout] 2021-07-17 23:48:44,155 INFO [kvs::server] Accept connection from client: 127.0.0.1:58852 [INFO] [stdout] 2021-07-17 23:48:44,155 INFO [kvs::server] Client: 127.0.0.1:58852 disconnected [INFO] [stdout] 2021-07-17 23:48:44,156 DEBUG [kvs::server] [client->server] {"Set":{"key":"key1","value":"value1"}} [INFO] [stdout] 2021-07-17 23:48:44,156 DEBUG [kvs::server] command: Set { key: "key1", value: "value1" } [INFO] [stdout] 2021-07-17 23:48:44,156 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stdout] 2021-07-17 23:48:44,163 INFO [kvs::server] Accept connection from client: 127.0.0.1:50580 [INFO] [stdout] 2021-07-17 23:48:44,164 INFO [kvs::server] Client: 127.0.0.1:50580 disconnected [INFO] [stdout] 2021-07-17 23:48:44,164 DEBUG [kvs::server] [client->server] {"Get":{"key":"key1"}} [INFO] [stdout] 2021-07-17 23:48:44,164 DEBUG [kvs::server] command: Get { key: "key1" } [INFO] [stdout] 2021-07-17 23:48:44,164 DEBUG [kvs::server] [server->client] Ok("value1") [INFO] [stdout] test cli_log_configuration ... ok2021-07-17 23:48:44,169 INFO [kvs::server] Accept connection from client: 127.0.0.1:58856 [INFO] [stdout] [INFO] [stdout] 2021-07-17 23:48:44,169 INFO [kvs::server] Client: 127.0.0.1:58856 disconnected [INFO] [stdout] 2021-07-17 23:48:44,169 DEBUG [kvs::server] [client->server] {"Get":{"key":"key1"}} [INFO] [stdout] 2021-07-17 23:48:44,169 DEBUG [kvs::server] command: Get { key: "key1" } [INFO] [stdout] 2021-07-17 23:48:44,170 DEBUG [kvs::server] [server->client] Ok("value1") [INFO] [stdout] 2021-07-17 23:48:44,176 INFO [kvs::server] Accept connection from client: 127.0.0.1:50584 [INFO] [stdout] 2021-07-17 23:48:44,176 INFO [kvs::server] Client: 127.0.0.1:50584 disconnected [INFO] [stdout] 2021-07-17 23:48:44,176 DEBUG [kvs::server] [client->server] {"Set":{"key":"key1","value":"value2"}} [INFO] [stdout] 2021-07-17 23:48:44,176 DEBUG [kvs::server] command: Set { key: "key1", value: "value2" } [INFO] [stdout] 2021-07-17 23:48:44,176 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 117 to 138 [INFO] [stdout] 2021-07-17 23:48:44,177 DEBUG [sled::pagecache::iobuf] wrote lsns 117-137 to disk at offsets 117-137, maxed false complete_len 21 [INFO] [stdout] 2021-07-17 23:48:44,177 DEBUG [sled::pagecache::iobuf] mark_interval(117, 21) [INFO] [stdout] 2021-07-17 23:48:44,177 DEBUG [sled::pagecache::iobuf] new highest interval: 117 - 137 [INFO] [stdout] 2021-07-17 23:48:44,177 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stdout] 2021-07-17 23:48:44,179 INFO [kvs::server] Accept connection from client: 127.0.0.1:58860 [INFO] [stdout] 2021-07-17 23:48:44,179 INFO [kvs::server] Client: 127.0.0.1:58860 disconnected [INFO] [stdout] 2021-07-17 23:48:44,183 DEBUG [kvs::server] [client->server] {"Set":{"key":"key1","value":"value2"}} [INFO] [stdout] 2021-07-17 23:48:44,184 DEBUG [kvs::server] command: Set { key: "key1", value: "value2" } [INFO] [stdout] 2021-07-17 23:48:44,184 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stdout] 2021-07-17 23:48:44,186 INFO [kvs::server] Accept connection from client: 127.0.0.1:50588 [INFO] [stdout] 2021-07-17 23:48:44,186 INFO [kvs::server] Client: 127.0.0.1:50588 disconnected [INFO] [stdout] 2021-07-17 23:48:44,186 DEBUG [kvs::server] [client->server] {"Get":{"key":"key1"}} [INFO] [stdout] 2021-07-17 23:48:44,186 DEBUG [kvs::server] command: Get { key: "key1" } [INFO] [stdout] 2021-07-17 23:48:44,186 DEBUG [kvs::server] [server->client] Ok("value2") [INFO] [stdout] 2021-07-17 23:48:44,196 INFO [kvs::server] Accept connection from client: 127.0.0.1:58866 [INFO] [stdout] 2021-07-17 23:48:44,196 INFO [kvs::server] Client: 127.0.0.1:58866 disconnected [INFO] [stdout] 2021-07-17 23:48:44,196 INFO [kvs::server] Accept connection from client: 127.0.0.1:50590 [INFO] [stdout] 2021-07-17 23:48:44,196 INFO [kvs::server] Client: 127.0.0.1:50590 disconnected [INFO] [stdout] 2021-07-17 23:48:44,197 DEBUG [kvs::server] [client->server] {"Get":{"key":"key1"}} [INFO] [stdout] 2021-07-17 23:48:44,197 DEBUG [kvs::server] command: Get { key: "key1" } [INFO] [stdout] 2021-07-17 23:48:44,197 DEBUG [kvs::server] [server->client] Ok("value2") [INFO] [stdout] 2021-07-17 23:48:44,197 DEBUG [kvs::server] [client->server] {"Get":{"key":"key2"}} [INFO] [stdout] 2021-07-17 23:48:44,197 DEBUG [kvs::server] command: Get { key: "key2" } [INFO] [stdout] 2021-07-17 23:48:44,197 DEBUG [kvs::server] [server->client] Ok("Key: key2 not found") [INFO] [stdout] 2021-07-17 23:48:44,205 INFO [kvs::server] Accept connection from client: 127.0.0.1:58868 [INFO] [stdout] 2021-07-17 23:48:44,205 INFO [kvs::server] Client: 127.0.0.1:58868 disconnected [INFO] [stdout] 2021-07-17 23:48:44,205 DEBUG [kvs::server] [client->server] {"Get":{"key":"key2"}} [INFO] [stdout] 2021-07-17 23:48:44,205 DEBUG [kvs::server] command: Get { key: "key2" } [INFO] [stdout] 2021-07-17 23:48:44,206 DEBUG [kvs::server] [server->client] Ok("Key: key2 not found") [INFO] [stdout] 2021-07-17 23:48:44,207 INFO [kvs::server] Accept connection from client: 127.0.0.1:50596 [INFO] [stdout] 2021-07-17 23:48:44,208 INFO [kvs::server] Client: 127.0.0.1:50596 disconnected [INFO] [stdout] 2021-07-17 23:48:44,208 DEBUG [kvs::server] [client->server] {"Rm":{"key":"key2"}} [INFO] [stdout] 2021-07-17 23:48:44,208 DEBUG [kvs::server] command: Rm { key: "key2" } [INFO] [stdout] 2021-07-17 23:48:44,208 DEBUG [kvs::server] [server->client] Error("Key: key2 not found.") [INFO] [stdout] 2021-07-17 23:48:44,208 INFO [kvs::server] Accept connection from client: 127.0.0.1:58872 [INFO] [stdout] 2021-07-17 23:48:44,208 INFO [kvs::server] Client: 127.0.0.1:58872 disconnected [INFO] [stdout] 2021-07-17 23:48:44,213 DEBUG [kvs::server] [client->server] {"Rm":{"key":"key2"}} [INFO] [stdout] 2021-07-17 23:48:44,214 DEBUG [kvs::server] command: Rm { key: "key2" } [INFO] [stdout] 2021-07-17 23:48:44,220 INFO [kvs::server] Accept connection from client: 127.0.0.1:50600 [INFO] [stdout] 2021-07-17 23:48:44,220 INFO [kvs::server] Client: 127.0.0.1:50600 disconnected [INFO] [stdout] 2021-07-17 23:48:44,221 DEBUG [kvs::server] [client->server] {"Set":{"key":"key2","value":"value3"}} [INFO] [stdout] 2021-07-17 23:48:44,221 DEBUG [kvs::server] command: Set { key: "key2", value: "value3" } [INFO] [stdout] 2021-07-17 23:48:44,222 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 138 to 159 [INFO] [stdout] 2021-07-17 23:48:44,222 DEBUG [sled::pagecache::iobuf] wrote lsns 138-158 to disk at offsets 138-158, maxed false complete_len 21 [INFO] [stdout] 2021-07-17 23:48:44,222 DEBUG [sled::pagecache::iobuf] mark_interval(138, 21) [INFO] [stdout] 2021-07-17 23:48:44,222 DEBUG [sled::pagecache::iobuf] new highest interval: 138 - 158 [INFO] [stdout] 2021-07-17 23:48:44,222 DEBUG [sled::pagecache::iobuf] make_stable(158) returning [INFO] [stdout] 2021-07-17 23:48:44,222 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stdout] 2021-07-17 23:48:44,226 INFO [kvs::server] Accept connection from client: 127.0.0.1:50602 [INFO] [stdout] 2021-07-17 23:48:44,226 INFO [kvs::server] Client: 127.0.0.1:50602 disconnected [INFO] [stdout] 2021-07-17 23:48:44,226 DEBUG [kvs::server] [client->server] {"Rm":{"key":"key1"}} [INFO] [stdout] 2021-07-17 23:48:44,227 DEBUG [kvs::server] command: Rm { key: "key1" } [INFO] [stdout] 2021-07-17 23:48:44,227 DEBUG [sled::pagecache::iobuf] advancing offset within the current segment from 159 to 173 [INFO] [stdout] 2021-07-17 23:48:44,228 DEBUG [sled::pagecache::iobuf] wrote lsns 159-172 to disk at offsets 159-172, maxed false complete_len 14 [INFO] [stdout] 2021-07-17 23:48:44,228 DEBUG [sled::pagecache::iobuf] mark_interval(159, 14) [INFO] [stdout] 2021-07-17 23:48:44,228 DEBUG [sled::pagecache::iobuf] new highest interval: 159 - 172 [INFO] [stdout] 2021-07-17 23:48:44,228 DEBUG [sled::pagecache::iobuf] make_stable(172) returning [INFO] [stdout] 2021-07-17 23:48:44,228 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stdout] 2021-07-17 23:48:44,248 INFO [kvs_server] Retrieving last work. engine: sled [INFO] [stdout] 2021-07-17 23:48:44,248 INFO [kvs_server] Listened at 127.0.0.1:4005, powered by sled, version: 0.1.0 [INFO] [stdout] 2021-07-17 23:48:44,258 DEBUG [kvs::server] [server->client] Error("Key: key2 not found.") [INFO] [stdout] 2021-07-17 23:48:44,268 INFO [kvs::server] Accept connection from client: 127.0.0.1:58878 [INFO] [stdout] 2021-07-17 23:48:44,268 INFO [kvs::server] Client: 127.0.0.1:58878 disconnected [INFO] [stdout] 2021-07-17 23:48:44,269 DEBUG [kvs::server] [client->server] {"Set":{"key":"key2","value":"value3"}} [INFO] [stdout] 2021-07-17 23:48:44,270 DEBUG [kvs::server] command: Set { key: "key2", value: "value3" } [INFO] [stdout] 2021-07-17 23:48:44,270 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stdout] 2021-07-17 23:48:44,289 INFO [kvs::server] Accept connection from client: 127.0.0.1:58880 [INFO] [stdout] 2021-07-17 23:48:44,289 INFO [kvs::server] Client: 127.0.0.1:58880 disconnected [INFO] [stdout] 2021-07-17 23:48:44,290 DEBUG [kvs::server] [client->server] {"Rm":{"key":"key1"}} [INFO] [stdout] 2021-07-17 23:48:44,290 DEBUG [kvs::server] command: Rm { key: "key1" } [INFO] [stdout] 2021-07-17 23:48:44,296 INFO [kvs_server] Listened at 127.0.0.1:4002, powered by kvs, version: 0.1.0 [INFO] [stderr] thread 'main' panicked at 'Failed to create a sled engine.: IO error: could not acquire lock on "/tmp/.tmpvnoOjE/db": Os { code: 11, kind: WouldBlock, message: "Resource temporarily unavailable" } [INFO] [stderr] [INFO] [stderr] Stack backtrace: [INFO] [stderr] 0: anyhow::error:: for anyhow::Error>::from [INFO] [stderr] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/anyhow-1.0.41/src/error.rs:519:25 [INFO] [stderr] 1: as core::ops::try_trait::FromResidual>>::from_residual [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/result.rs:1653:27 [INFO] [stderr] 2: kvs::sled::SledAdapter::open [INFO] [stderr] at /opt/rustwide/workdir/src/sled.rs:20:17 [INFO] [stderr] 3: kvs_server::main [INFO] [stderr] at /opt/rustwide/workdir/src/bin/kvs-server.rs:62:13 [INFO] [stderr] 4: core::ops::function::FnOnce::call_once [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5 [INFO] [stderr] 5: std::sys_common::backtrace::__rust_begin_short_backtrace [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:125:18 [INFO] [stderr] 6: std::rt::lang_start::{{closure}} [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:63:18 [INFO] [stderr] 7: core::ops::function::impls:: for &F>::call_once [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:259:13 [INFO] [stderr] 8: std::panicking::try::do_call [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40 [INFO] [stderr] 9: std::panicking::try [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19 [INFO] [stderr] 10: std::panic::catch_unwind [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14 [INFO] [stderr] 11: std::rt::lang_start_internal::{{closure}} [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:45:48 [INFO] [stderr] 12: std::panicking::try::do_call [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40 [INFO] [stderr] 13: std::panicking::try [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19 [INFO] [stderr] 14: std::panic::catch_unwind [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14 [INFO] [stderr] 15: std::rt::lang_start_internal [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:45:20 [INFO] [stderr] 16: std::rt::lang_start [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:62:5 [INFO] [stderr] 17: main [INFO] [stderr] 18: __libc_start_main [INFO] [stderr] 19: _start', src/bin/kvs-server.rs:62:54 [INFO] [stderr] stack backtrace: [INFO] [stderr] 0: 0x56253178cdb0 - std::backtrace_rs::backtrace::libunwind::trace::h706b838f5bbd876b [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/libunwind.rs:90:5 [INFO] [stderr] 1: 0x56253178cdb0 - std::backtrace_rs::backtrace::trace_unsynchronized::hc15f29ae7822b7b8 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stderr] 2: 0x56253178cdb0 - std::sys_common::backtrace::_print_fmt::h7c580c971f91926c [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:67:5 [INFO] [stderr] 3: 0x56253178cdb0 - ::fmt::h2a772198c4032452 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:46:22 [INFO] [stderr] 4: 0x5625317afd9c - core::fmt::write::h9a6d9c74526a6c1b [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/fmt/mod.rs:1115:17 [INFO] [stderr] 5: 0x562531787b85 - std::io::Write::write_fmt::h00f38d9eb2c32e02 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/io/mod.rs:1663:15 [INFO] [stderr] 6: 0x56253178f2db - std::sys_common::backtrace::_print::h5b3c171e6f864ae4 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:49:5 [INFO] [stderr] 7: 0x56253178f2db - std::sys_common::backtrace::print::h93b9e9ed2a98e611 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:36:9 [INFO] [stderr] 8: 0x56253178f2db - std::panicking::default_hook::{{closure}}::hd8da92bb68d520c5 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:208:50 [INFO] [stderr] 9: 0x56253178edb1 - std::panicking::default_hook::hdbc8b2951c5afbab [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:225:9 [INFO] [stderr] 10: 0x56253178f9a4 - std::panicking::rust_panic_with_hook::h8a4c841655926f4e [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:622:17 [INFO] [stderr] 11: 0x56253178f487 - std::panicking::begin_panic_handler::{{closure}}::h471b6bc74904b7b0 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:519:13 [INFO] [stderr] 12: 0x56253178d2ac - std::sys_common::backtrace::__rust_end_short_backtrace::h309f5c707f29932f [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:141:18 [INFO] [stderr] 13: 0x56253178f3e9 - rust_begin_unwind [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:515:5 [INFO] [stderr] 14: 0x56253134b881 - core::panicking::panic_fmt::hcf5f6d96e1dd7099 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/panicking.rs:92:14 [INFO] [stderr] 15: 0x56253134b973 - core::result::unwrap_failed::he898b02f57993c42 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/result.rs:1355:5 [INFO] [stderr] 16: 0x562531358bbd - core::result::Result::expect::h0f9c5de2e4ca6b4b [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/result.rs:997:23 [INFO] [stderr] 17: 0x56253136c7db - kvs_server::main::ha584ddb15ef128c3 [INFO] [stderr] at /opt/rustwide/workdir/src/bin/kvs-server.rs:62:13 [INFO] [stderr] 18: 0x56253135ea8b - core::ops::function::FnOnce::call_once::h0479fa2599b5205f [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5 [INFO] [stderr] 19: 0x5625313604ce - std::sys_common::backtrace::__rust_begin_short_backtrace::h625b93b319b0e1bf [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:125:18 [INFO] [stderr] 20: 0x56253135e4d1 - std::rt::lang_start::{{closure}}::h9bdbef4f8393c2be [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:63:18 [INFO] [stderr] 21: 0x56253178feaa - core::ops::function::impls:: for &F>::call_once::hcbe5785d54a49ce2 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:259:13 [INFO] [stderr] 22: 0x56253178feaa - std::panicking::try::do_call::h1c15e7ee8563c29d [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40 [INFO] [stderr] 23: 0x56253178feaa - std::panicking::try::hb8b07cef009cb4fc [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19 [INFO] [stderr] 24: 0x56253178feaa - std::panic::catch_unwind::h65a8efbe596bcbb1 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14 [INFO] [stderr] 25: 0x56253178feaa - std::rt::lang_start_internal::{{closure}}::h66ded7ab0f18e9fb [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:45:48 [INFO] [stderr] 26: 0x56253178feaa - std::panicking::try::do_call::h29cafa65efb3f3f3 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40 [INFO] [stderr] 27: 0x56253178feaa - std::panicking::try::h412fc5378b4dbfc4 [INFO] [stdout] 2021-07-17 23:48:44,351 DEBUG [kvs::server] [server->client] Ok("") [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19 [INFO] [stderr] 28: 0x56253178feaa - std::panic::catch_unwind::h555def6aac5bf192 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14 [INFO] [stderr] 29: 0x56253178feaa - std::rt::lang_start_internal::hfff48202d7fee6e3 [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:45:20 [INFO] [stderr] 30: 0x56253135e4a0 - std::rt::lang_start::hcc32cda9a3c1afba [INFO] [stderr] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/rt.rs:62:5 [INFO] [stderr] 31: 0x56253136d6fc - main [INFO] [stderr] 32: 0x7ff5cd8720b3 - __libc_start_main [INFO] [stderr] 33: 0x56253134c07e - _start [INFO] [stderr] 34: 0x0 - [INFO] [stdout] 2021-07-17 23:48:44,364 INFO [kvs_server] Retrieving last work. engine: kvs [INFO] [stdout] 2021-07-17 23:48:44,364 INFO [kvs_server] Listened at 127.0.0.1:4004, powered by kvs, version: 0.1.0 [INFO] [stdout] test cli_access_server_sled_engine ... FAILED [INFO] [stdout] test cli_wrong_engine ... ok [INFO] [stdout] 2021-07-17 23:48:45,376 INFO [kvs::server] Accept connection from client: 127.0.0.1:58884 [INFO] [stdout] 2021-07-17 23:48:45,376 INFO [kvs::server] Client: 127.0.0.1:58884 disconnected [INFO] [stdout] 2021-07-17 23:48:45,376 DEBUG [kvs::server] [client->server] {"Get":{"key":"key2"}} [INFO] [stdout] 2021-07-17 23:48:45,376 DEBUG [kvs::server] command: Get { key: "key2" } [INFO] [stdout] 2021-07-17 23:48:45,376 DEBUG [kvs::server] [server->client] Ok("value3") [INFO] [stdout] 2021-07-17 23:48:45,379 INFO [kvs::server] Accept connection from client: 127.0.0.1:58886 [INFO] [stdout] 2021-07-17 23:48:45,380 INFO [kvs::server] Client: 127.0.0.1:58886 disconnected [INFO] [stdout] 2021-07-17 23:48:45,380 DEBUG [kvs::server] [client->server] {"Get":{"key":"key1"}} [INFO] [stdout] 2021-07-17 23:48:45,380 DEBUG [kvs::server] command: Get { key: "key1" } [INFO] [stdout] 2021-07-17 23:48:45,380 DEBUG [kvs::server] [server->client] Ok("Key: key1 not found") [INFO] [stdout] test cli_access_server_kvs_engine ... ok [INFO] [stdout] [INFO] [stdout] failures: [INFO] [stdout] [INFO] [stdout] ---- cli_access_server_sled_engine stdout ---- [INFO] [stdout] thread 'cli_access_server_sled_engine' panicked at 'Unexpected failure. [INFO] [stdout] code-255 [INFO] [stdout] stderr=```Connection refused (os error 111) [INFO] [stdout] ``` [INFO] [stdout] command=`"/opt/rustwide/target/debug/kvs-client" "get" "key2" "--addr" "127.0.0.1:4005"` [INFO] [stdout] code=255 [INFO] [stdout] stdout=`````` [INFO] [stdout] stderr=```Connection refused (os error 111) [INFO] [stdout] ``` [INFO] [stdout] ', /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/assert_cmd-0.11.1/src/assert.rs:154:13 [INFO] [stdout] stack backtrace: [INFO] [stdout] 0: 0x55d68b8a1310 - std::backtrace_rs::backtrace::libunwind::trace::h706b838f5bbd876b [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/libunwind.rs:90:5 [INFO] [stdout] 1: 0x55d68b8a1310 - std::backtrace_rs::backtrace::trace_unsynchronized::hc15f29ae7822b7b8 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stdout] 2: 0x55d68b8a1310 - std::sys_common::backtrace::_print_fmt::h7c580c971f91926c [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:67:5 [INFO] [stdout] 3: 0x55d68b8a1310 - ::fmt::h2a772198c4032452 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:46:22 [INFO] [stdout] 4: 0x55d68b8c4ffc - core::fmt::write::h9a6d9c74526a6c1b [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/fmt/mod.rs:1115:17 [INFO] [stdout] 5: 0x55d68b89dd05 - std::io::Write::write_fmt::h583dff5009d01a9f [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/io/mod.rs:1663:15 [INFO] [stdout] 6: 0x55d68b8a390b - std::sys_common::backtrace::_print::h5b3c171e6f864ae4 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:49:5 [INFO] [stdout] 7: 0x55d68b8a390b - std::sys_common::backtrace::print::h93b9e9ed2a98e611 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:36:9 [INFO] [stdout] 8: 0x55d68b8a390b - std::panicking::default_hook::{{closure}}::hd8da92bb68d520c5 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:208:50 [INFO] [stdout] 9: 0x55d68b8a341c - std::panicking::default_hook::hdbc8b2951c5afbab [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:222:9 [INFO] [stdout] 10: 0x55d68b8a3fd4 - std::panicking::rust_panic_with_hook::h8a4c841655926f4e [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:622:17 [INFO] [stdout] 11: 0x55d68b8a3ab7 - std::panicking::begin_panic_handler::{{closure}}::h471b6bc74904b7b0 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:519:13 [INFO] [stdout] 12: 0x55d68b8a180c - std::sys_common::backtrace::__rust_end_short_backtrace::h309f5c707f29932f [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:141:18 [INFO] [stdout] 13: 0x55d68b8a3a19 - rust_begin_unwind [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:515:5 [INFO] [stdout] 14: 0x55d68b7b6f3b - std::panicking::begin_panic_fmt::h124dfb9fde553188 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:457:5 [INFO] [stdout] 15: 0x55d68b8527ab - assert_cmd::assert::Assert::success::h83ca514f0a4924ed [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/assert_cmd-0.11.1/src/assert.rs:154:13 [INFO] [stdout] 16: 0x55d68b7d150a - cli::cli_access_server::hf7005233853a3474 [INFO] [stdout] at /opt/rustwide/workdir/tests/cli.rs:313:5 [INFO] [stdout] 17: 0x55d68b7d3b4e - cli::cli_access_server_sled_engine::he7c9394b834bbba8 [INFO] [stdout] at /opt/rustwide/workdir/tests/cli.rs:338:5 [INFO] [stdout] 18: 0x55d68b7d3b1a - cli::cli_access_server_sled_engine::{{closure}}::h22b24ce53c6a5101 [INFO] [stdout] at /opt/rustwide/workdir/tests/cli.rs:337:1 [INFO] [stdout] 19: 0x55d68b7c677e - core::ops::function::FnOnce::call_once::h700b134a1af220d6 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 20: 0x55d68b7fbe03 - core::ops::function::FnOnce::call_once::h99a97b0ff983bd25 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 21: 0x55d68b7fbe03 - test::__rust_begin_short_backtrace::h8fe0d26ed1584e50 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:577:5 [INFO] [stdout] 22: 0x55d68b7fa890 - as core::ops::function::FnOnce>::call_once::he6b90e352f394d8f [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9 [INFO] [stdout] 23: 0x55d68b7fa890 - as core::ops::function::FnOnce<()>>::call_once::h1c05475e029700b8 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:347:9 [INFO] [stdout] 24: 0x55d68b7fa890 - std::panicking::try::do_call::he6de943476ae628a [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40 [INFO] [stdout] 25: 0x55d68b7fa890 - std::panicking::try::ha21937b8feb06f89 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19 [INFO] [stdout] 26: 0x55d68b7fa890 - std::panic::catch_unwind::ha79830b3325c9fa6 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14 [INFO] [stdout] 27: 0x55d68b7fa890 - test::run_test_in_process::h1ab180b83ee2d5b5 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:600:18 [INFO] [stdout] 28: 0x55d68b7fa890 - test::run_test::run_test_inner::{{closure}}::h8258ffe088f187a1 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:492:39 [INFO] [stdout] 29: 0x55d68b7d3e52 - test::run_test::run_test_inner::{{closure}}::hc697b214abd32bc6 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:519:37 [INFO] [stdout] 30: 0x55d68b7d3e52 - std::sys_common::backtrace::__rust_begin_short_backtrace::h64de0d3f894854a9 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:125:18 [INFO] [stdout] 31: 0x55d68b7d7aa8 - std::thread::Builder::spawn_unchecked::{{closure}}::{{closure}}::h1fd98fc86e533ece [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/thread/mod.rs:476:17 [INFO] [stdout] 32: 0x55d68b7d7aa8 - as core::ops::function::FnOnce<()>>::call_once::h4e2a7abf702e4cfd [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:347:9 [INFO] [stdout] 33: 0x55d68b7d7aa8 - std::panicking::try::do_call::h4496392321a3c8c0 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40 [INFO] [stdout] 34: 0x55d68b7d7aa8 - std::panicking::try::hf1e14258e04e8e9a [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19 [INFO] [stdout] 35: 0x55d68b7d7aa8 - std::panic::catch_unwind::hb72c3777cd55642f [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14 [INFO] [stdout] 36: 0x55d68b7d7aa8 - std::thread::Builder::spawn_unchecked::{{closure}}::h2d7915a5910e148e [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/thread/mod.rs:475:30 [INFO] [stdout] 37: 0x55d68b7d7aa8 - core::ops::function::FnOnce::call_once{{vtable.shim}}::h83fd2f1ef5be797c [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 38: 0x55d68b8a9a37 - as core::ops::function::FnOnce>::call_once::ha8b1d5a0092467fc [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9 [INFO] [stdout] 39: 0x55d68b8a9a37 - as core::ops::function::FnOnce>::call_once::h4b9f24ec4e8a879e [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9 [INFO] [stdout] 40: 0x55d68b8a9a37 - std::sys::unix::thread::Thread::new::thread_start::h2a0e98fbc4ab4c32 [INFO] [stdout] at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys/unix/thread.rs:72:17 [INFO] [stdout] 41: 0x7f3b6d621609 - start_thread [INFO] [stdout] 42: 0x7f3b6d3f3293 - clone [INFO] [stdout] 43: 0x0 - [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] failures: [INFO] [stdout] cli_access_server_sled_engine [INFO] [stdout] [INFO] [stdout] test result: FAILED. 10 passed; 1 failed; 0 ignored; 0 measured; 0 filtered out; finished in 2.24s [INFO] [stdout] [INFO] [stderr] error: test failed, to rerun pass '--test cli' [INFO] running `Command { std: "docker" "inspect" "7be637aaa6714831f85f0bf123407eb3e266829e2c0a935c0d2b373273bf97e8", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "7be637aaa6714831f85f0bf123407eb3e266829e2c0a935c0d2b373273bf97e8", kill_on_drop: false }` [INFO] [stdout] 7be637aaa6714831f85f0bf123407eb3e266829e2c0a935c0d2b373273bf97e8