[INFO] fetching crate pliantdb-local 0.1.0-dev.3... [INFO] testing pliantdb-local-0.1.0-dev.3 against try#ce59db7a1b1b012fb2793c4641c1bdecad7a128b for pr-85530 [INFO] extracting crate pliantdb-local 0.1.0-dev.3 into /workspace/builds/worker-6/source [INFO] validating manifest of crates.io crate pliantdb-local 0.1.0-dev.3 on toolchain ce59db7a1b1b012fb2793c4641c1bdecad7a128b [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+ce59db7a1b1b012fb2793c4641c1bdecad7a128b" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking crates.io crate pliantdb-local 0.1.0-dev.3 [INFO] finished tweaking crates.io crate pliantdb-local 0.1.0-dev.3 [INFO] tweaked toml for crates.io crate pliantdb-local 0.1.0-dev.3 written to /workspace/builds/worker-6/source/Cargo.toml [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+ce59db7a1b1b012fb2793c4641c1bdecad7a128b" "generate-lockfile" "--manifest-path" "Cargo.toml" "-Zno-index-update", kill_on_drop: false }` [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+ce59db7a1b1b012fb2793c4641c1bdecad7a128b" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/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:20528e8c29e4536546f0102ce88568b16ea7538393a33fcca951030f7af10457" "/opt/rustwide/cargo-home/bin/cargo" "+ce59db7a1b1b012fb2793c4641c1bdecad7a128b" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] a83d1876934edc3445ede8e4253eb3ce09f69d03a9000219b2b922bb5ce5519c [INFO] running `Command { std: "docker" "start" "-a" "a83d1876934edc3445ede8e4253eb3ce09f69d03a9000219b2b922bb5ce5519c", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "a83d1876934edc3445ede8e4253eb3ce09f69d03a9000219b2b922bb5ce5519c", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "a83d1876934edc3445ede8e4253eb3ce09f69d03a9000219b2b922bb5ce5519c", kill_on_drop: false }` [INFO] [stdout] a83d1876934edc3445ede8e4253eb3ce09f69d03a9000219b2b922bb5ce5519c [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/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:20528e8c29e4536546f0102ce88568b16ea7538393a33fcca951030f7af10457" "/opt/rustwide/cargo-home/bin/cargo" "+ce59db7a1b1b012fb2793c4641c1bdecad7a128b" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 22d1e8831d5650f6a18b90b2904a83b3e57a2629a29491baee3b964bb353b19f [INFO] running `Command { std: "docker" "start" "-a" "22d1e8831d5650f6a18b90b2904a83b3e57a2629a29491baee3b964bb353b19f", kill_on_drop: false }` [INFO] [stderr] Compiling syn v1.0.72 [INFO] [stderr] Compiling autocfg v1.0.1 [INFO] [stderr] Compiling libc v0.2.95 [INFO] [stderr] Compiling version_check v0.9.3 [INFO] [stderr] Compiling once_cell v1.7.2 [INFO] [stderr] Compiling lazy_static v1.4.0 [INFO] [stderr] Compiling futures-core v0.3.15 [INFO] [stderr] Compiling bitflags v1.2.1 [INFO] [stderr] Compiling log v0.4.14 [INFO] [stderr] Compiling spin v0.5.2 [INFO] [stderr] Compiling untrusted v0.7.1 [INFO] [stderr] Compiling proc-macro-hack v0.5.19 [INFO] [stderr] Compiling scopeguard v1.1.0 [INFO] [stderr] Compiling pin-project-lite v0.2.6 [INFO] [stderr] Compiling futures-channel v0.3.15 [INFO] [stderr] Compiling futures-task v0.3.15 [INFO] [stderr] Compiling radium v0.5.3 [INFO] [stderr] Compiling proc-macro-nested v0.1.7 [INFO] [stderr] Compiling slab v0.4.3 [INFO] [stderr] Compiling futures-io v0.3.15 [INFO] [stderr] Compiling funty v1.1.0 [INFO] [stderr] Compiling pin-utils v0.1.0 [INFO] [stderr] Compiling wyz v0.2.0 [INFO] [stderr] Compiling tap v1.0.1 [INFO] [stderr] Compiling tinyvec_macros v0.1.0 [INFO] [stderr] Compiling base64 v0.13.0 [INFO] [stderr] Compiling bytes v1.0.1 [INFO] [stderr] Compiling matches v0.1.8 [INFO] [stderr] Compiling trybuild v1.0.42 [INFO] [stderr] Compiling itoa v0.4.7 [INFO] [stderr] Compiling oid-registry v0.1.3 [INFO] [stderr] Compiling openssl-probe v0.1.4 [INFO] [stderr] Compiling rustversion v1.0.5 [INFO] [stderr] Compiling async-trait v0.1.50 [INFO] [stderr] Compiling percent-encoding v2.1.0 [INFO] [stderr] Compiling half v1.7.1 [INFO] [stderr] Compiling crossbeam-epoch v0.9.5 [INFO] [stderr] Compiling if_chain v1.0.1 [INFO] [stderr] Compiling ring v0.16.20 [INFO] [stderr] Compiling instant v0.1.9 [INFO] [stderr] Compiling unicode-bidi v0.3.5 [INFO] [stderr] Compiling tinyvec v1.2.0 [INFO] [stderr] Compiling tracing-core v0.1.18 [INFO] [stderr] Compiling lock_api v0.4.4 [INFO] [stderr] Compiling fxhash v0.2.1 [INFO] [stderr] Compiling crossbeam-utils v0.8.5 [INFO] [stderr] Compiling crc32fast v1.2.1 [INFO] [stderr] Compiling form_urlencoded v1.0.1 [INFO] [stderr] Compiling spinning_top v0.2.4 [INFO] [stderr] Compiling lexical-core v0.7.6 [INFO] [stderr] Compiling num-traits v0.2.14 [INFO] [stderr] Compiling num-integer v0.1.44 [INFO] [stderr] Compiling futures-macro v0.3.15 [INFO] [stderr] Compiling futures-util v0.3.15 [INFO] [stderr] Compiling num-bigint v0.4.0 [INFO] [stderr] Compiling tokio v1.6.1 [INFO] [stderr] Compiling memoffset v0.6.4 [INFO] [stderr] Compiling nom v6.1.2 [INFO] [stderr] Compiling generic-array v0.14.4 [INFO] [stderr] Compiling proc-macro-error-attr v1.0.4 [INFO] [stderr] Compiling proc-macro-error v1.0.4 [INFO] [stderr] Compiling bitvec v0.19.5 [INFO] [stderr] Compiling getrandom v0.2.3 [INFO] [stderr] Compiling parking_lot_core v0.8.3 [INFO] [stderr] Compiling signal-hook-registry v1.4.0 [INFO] [stderr] Compiling num_cpus v1.13.0 [INFO] [stderr] Compiling mio v0.7.11 [INFO] [stderr] Compiling socket2 v0.3.19 [INFO] [stderr] Compiling atty v0.2.14 [INFO] [stderr] Compiling fs2 v0.4.3 [INFO] [stderr] Compiling clap v2.33.3 [INFO] [stderr] Compiling rand_core v0.6.2 [INFO] [stderr] Compiling nanorand v0.5.2 [INFO] [stderr] Compiling unicode-normalization v0.1.19 [INFO] [stderr] Compiling parking_lot v0.11.1 [INFO] [stderr] Compiling digest v0.9.0 [INFO] [stderr] Compiling block-buffer v0.9.0 [INFO] [stderr] Compiling rand_chacha v0.3.0 [INFO] [stderr] Compiling chrono v0.4.19 [INFO] [stderr] Compiling sha2 v0.9.5 [INFO] [stderr] Compiling rand v0.8.3 [INFO] [stderr] Compiling sled v0.34.6 [INFO] [stderr] Compiling yasna v0.4.0 [INFO] [stderr] Compiling idna v0.2.3 [INFO] [stderr] Compiling sct v0.6.1 [INFO] [stderr] Compiling webpki v0.21.4 [INFO] [stderr] Compiling rcgen v0.8.11 [INFO] [stderr] Compiling ct-logs v0.8.0 [INFO] [stderr] Compiling url v2.2.2 [INFO] [stderr] Compiling rustls v0.19.1 [INFO] [stderr] Compiling webpki-roots v0.21.1 [INFO] [stderr] Compiling synstructure v0.12.4 [INFO] [stderr] Compiling rusticata-macros v3.0.1 [INFO] [stderr] Compiling rustls-native-certs v0.5.0 [INFO] [stderr] Compiling serde_derive v1.0.126 [INFO] [stderr] Compiling pin-project-internal v1.0.7 [INFO] [stderr] Compiling tokio-macros v1.2.0 [INFO] [stderr] Compiling thiserror-impl v1.0.25 [INFO] [stderr] Compiling der-oid-macro v0.4.0 [INFO] [stderr] Compiling tracing-attributes v0.1.15 [INFO] [stderr] Compiling zeroize_derive v1.1.0 [INFO] [stderr] Compiling allochronic-util-macros v0.0.1-dev-1 [INFO] [stderr] Compiling structopt-derive v0.4.14 [INFO] [stderr] Compiling zeroize v1.3.0 [INFO] [stderr] Compiling der-parser v5.1.0 [INFO] [stderr] Compiling thiserror v1.0.25 [INFO] [stderr] Compiling pin-project v1.0.7 [INFO] [stderr] Compiling flume v0.10.5 [INFO] [stderr] Compiling tracing v0.1.26 [INFO] [stderr] Compiling structopt v0.3.21 [INFO] [stderr] Compiling quinn-proto v0.7.3 [INFO] [stderr] Compiling x509-parser v0.9.2 [INFO] [stderr] Compiling serde v1.0.126 [INFO] [stderr] Compiling futures-executor v0.3.15 [INFO] [stderr] Compiling futures v0.3.15 [INFO] [stderr] Compiling quinn v0.7.2 [INFO] [stderr] Compiling serde_json v1.0.64 [INFO] [stderr] Compiling toml v0.5.8 [INFO] [stderr] Compiling bincode v1.3.3 [INFO] [stderr] Compiling serde_cbor v0.11.1 [INFO] [stderr] Compiling pliantdb-jobs v0.1.0-dev.3 [INFO] [stderr] Compiling circulate v0.1.0-dev.1 [INFO] [stderr] Compiling allochronic-util v0.0.1-dev-1 [INFO] [stderr] Compiling fabruic v0.0.1-dev.2 [INFO] [stderr] Compiling pliantdb-core v0.1.0-dev.3 [INFO] [stderr] Compiling pliantdb-local v0.1.0-dev.3 (/opt/rustwide/workdir) [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 1m 28s [INFO] running `Command { std: "docker" "inspect" "22d1e8831d5650f6a18b90b2904a83b3e57a2629a29491baee3b964bb353b19f", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "22d1e8831d5650f6a18b90b2904a83b3e57a2629a29491baee3b964bb353b19f", kill_on_drop: false }` [INFO] [stdout] 22d1e8831d5650f6a18b90b2904a83b3e57a2629a29491baee3b964bb353b19f [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/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:20528e8c29e4536546f0102ce88568b16ea7538393a33fcca951030f7af10457" "/opt/rustwide/cargo-home/bin/cargo" "+ce59db7a1b1b012fb2793c4641c1bdecad7a128b" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] eaa2df6f93f115bc3644628122d1ac00d8eb01b8c57ad64972cd5ce5a630e60a [INFO] running `Command { std: "docker" "start" "-a" "eaa2df6f93f115bc3644628122d1ac00d8eb01b8c57ad64972cd5ce5a630e60a", kill_on_drop: false }` [INFO] [stderr] Compiling plotters-backend v0.3.0 [INFO] [stderr] Compiling regex-syntax v0.6.25 [INFO] [stderr] Compiling same-file v1.0.6 [INFO] [stderr] Compiling oorandom v11.1.3 [INFO] [stderr] Compiling rayon v1.5.1 [INFO] [stderr] Compiling crossbeam-channel v0.5.1 [INFO] [stderr] Compiling csv-core v0.1.10 [INFO] [stderr] Compiling crossbeam-deque v0.8.0 [INFO] [stderr] Compiling cast v0.2.6 [INFO] [stderr] Compiling bstr v0.2.16 [INFO] [stderr] Compiling tinytemplate v1.2.1 [INFO] [stderr] Compiling walkdir v2.3.2 [INFO] [stderr] Compiling criterion-plot v0.4.3 [INFO] [stderr] Compiling plotters-svg v0.3.0 [INFO] [stderr] Compiling rayon-core v1.9.1 [INFO] [stderr] Compiling plotters v0.3.1 [INFO] [stderr] Compiling csv v1.1.6 [INFO] [stderr] Compiling regex v1.5.4 [INFO] [stderr] Compiling criterion v0.3.4 [INFO] [stderr] Compiling pliantdb-local v0.1.0-dev.3 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 47.93s [INFO] running `Command { std: "docker" "inspect" "eaa2df6f93f115bc3644628122d1ac00d8eb01b8c57ad64972cd5ce5a630e60a", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "eaa2df6f93f115bc3644628122d1ac00d8eb01b8c57ad64972cd5ce5a630e60a", kill_on_drop: false }` [INFO] [stdout] eaa2df6f93f115bc3644628122d1ac00d8eb01b8c57ad64972cd5ce5a630e60a [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6/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:20528e8c29e4536546f0102ce88568b16ea7538393a33fcca951030f7af10457" "/opt/rustwide/cargo-home/bin/cargo" "+ce59db7a1b1b012fb2793c4641c1bdecad7a128b" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 320109ae5fa05d843f705a00bc9bdd19f898700bab5b89bb5fc4e3cc1962ed49 [INFO] running `Command { std: "docker" "start" "-a" "320109ae5fa05d843f705a00bc9bdd19f898700bab5b89bb5fc4e3cc1962ed49", kill_on_drop: false }` [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.15s [INFO] [stdout] [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/pliantdb_local-d9ace338b8d2a1eb) [INFO] [stdout] running 30 tests [INFO] [stdout] test error::test_converting_error ... ok [INFO] [stdout] test storage::name_validation_tests ... ok [INFO] [stdout] test storage::kv::tests::basic_expiration ... ok [INFO] [stdout] test storage::kv::tests::clearing_expiration ... ok [INFO] [stdout] test tests::publish_to_all_test ... ok [INFO] [stdout] test storage::kv::tests::updating_expiration ... FAILED [INFO] [stdout] test storage::kv::tests::multiple_keys_expiration ... FAILED [INFO] [stdout] test tests::bad_update ... ok [INFO] [stdout] test tests::unsubscribe_test ... ok [INFO] [stdout] test tests::not_found ... ok [INFO] [stdout] test tests::unassociated_collection ... ok [INFO] [stdout] test tests::kv_set_tests ... ok [INFO] [stdout] test tests::conflict ... ok [INFO] [stdout] test tests::no_update ... ok [INFO] [stdout] test tests::get_multiple ... ok [INFO] [stdout] test tests::multiple_subscribers_test ... ok [INFO] [stdout] test tests::store_retrieve_update_delete ... ok [INFO] [stdout] test tests::basic_kv_test ... ok [INFO] [stdout] test tests::simple_pubsub_test ... ok [INFO] [stdout] test tests::view_access_policies ... ok [INFO] [stdout] test tests::server_connection_tests ... ok [INFO] [stdout] test tests::view_query ... ok [INFO] [stdout] test tests::view_update ... ok [INFO] [stdout] test backup::tests::backup_restore ... ok [INFO] [stdout] test tests::list_transactions ... ok [INFO] [stdout] test storage::kv::tests::out_of_order_expiration ... FAILED [INFO] [stdout] test tests::integrity_checks ... ok [INFO] [stdout] test tests::delete_expire_tests ... ok [INFO] [stdout] test tests::expiration_after_close ... ok [INFO] [stdout] test tests::kv_expiration_tests ... ok [INFO] [stdout] [INFO] [stdout] failures: [INFO] [stdout] [INFO] [stdout] ---- storage::kv::tests::updating_expiration stdout ---- [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 99.805307ms [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 999.799797ms [INFO] [stdout] thread 'storage::kv::tests::updating_expiration' panicked at 'assertion failed: tree.get(b\"akey\")?.is_some()', src/storage/kv.rs:194:17 [INFO] [stdout] stack backtrace: [INFO] [stdout] 0: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::backtrace_rs::backtrace::libunwind::trace [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/../../backtrace/src/backtrace/libunwind.rs:90:5 [INFO] [stdout] 1: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::backtrace_rs::backtrace::trace_unsynchronized:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stdout] 2: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::sys_common::backtrace::_print_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:67:5 [INFO] [stdout] 3: 0x5624e56f73e0 - ::fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:46:22 [INFO] [stdout] 4: 0x5624e571c40c - core[ee1ca6415511a9c4]::fmt::write [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/fmt/mod.rs:1110:17 [INFO] [stdout] 5: 0x5624e56f3825 - as std[77c0456e0eb29f0c]::io::Write>::write_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/io/mod.rs:1584:15 [INFO] [stdout] 6: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::sys_common::backtrace::_print [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:49:5 [INFO] [stdout] 7: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::sys_common::backtrace::print [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:36:9 [INFO] [stdout] 8: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::panicking::default_hook::{closure#1} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:208:50 [INFO] [stdout] 9: 0x5624e56f955c - std[77c0456e0eb29f0c]::panicking::default_hook [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:222:9 [INFO] [stdout] 10: 0x5624e56fa0f1 - std[77c0456e0eb29f0c]::panicking::rust_panic_with_hook [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:622:17 [INFO] [stdout] 11: 0x5624e56f9bc7 - std[77c0456e0eb29f0c]::panicking::begin_panic_handler::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:517:13 [INFO] [stdout] 12: 0x5624e56f78dc - std[77c0456e0eb29f0c]::sys_common::backtrace::__rust_end_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:141:18 [INFO] [stdout] 13: 0x5624e56f9b59 - rust_begin_unwind [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:515:5 [INFO] [stdout] 14: 0x5624e4da6aa1 - core[ee1ca6415511a9c4]::panicking::panic_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/panicking.rs:92:14 [INFO] [stdout] 15: 0x5624e4da69ed - core[ee1ca6415511a9c4]::panicking::panic [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/panicking.rs:50:5 [INFO] [stdout] 16: 0x5624e52776d8 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::updating_expiration::{closure#0}::{closure#0}::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:194:17 [INFO] [stdout] 17: 0x5624e50c1929 - as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 18: 0x5624e4fdbde0 - > as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/future/maybe_done.rs:68:48 [INFO] [stdout] 19: 0x5624e52700c9 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::run_test::>::{closure#0}::{closure#1} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/macros/join.rs:86:20 [INFO] [stdout] 20: 0x5624e50777e8 - >::{closure#0}::{closure#1}> as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/future/poll_fn.rs:38:9 [INFO] [stdout] 21: 0x5624e5272b6d - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::run_test::>::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:148:24 [INFO] [stdout] 22: 0x5624e50bea69 - >::{closure#0}> as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 23: 0x5624e5277d39 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::updating_expiration::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:175:9 [INFO] [stdout] 24: 0x5624e50c65f9 - as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 25: 0x5624e51d047f - > as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/future.rs:120:9 [INFO] [stdout] 26: 0x5624e52bf5b0 - >::block_on::>>::{closure#0}::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:213:62 [INFO] [stdout] 27: 0x5624e525e022 - tokio[e61fd428a8c2bff2]::coop::with_budget::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:106:9 [INFO] [stdout] 28: 0x5624e4ebade3 - >>::try_with::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0}, core[ee1ca6415511a9c4]::task::poll::Poll>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/local.rs:400:16 [INFO] [stdout] 29: 0x5624e4eb1b8d - >>::with::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0}, core[ee1ca6415511a9c4]::task::poll::Poll>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/local.rs:376:9 [INFO] [stdout] 30: 0x5624e52b5b2c - tokio[e61fd428a8c2bff2]::coop::with_budget::>, >::block_on>>::{closure#0}::{closure#0}> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:99:5 [INFO] [stdout] 31: 0x5624e52b5b2c - tokio[e61fd428a8c2bff2]::coop::budget::>, >::block_on>>::{closure#0}::{closure#0}> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:76:5 [INFO] [stdout] 32: 0x5624e52b5b2c - >::block_on::>>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:213:39 [INFO] [stdout] 33: 0x5624e52ba761 - tokio[e61fd428a8c2bff2]::runtime::basic_scheduler::enter::<>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:323:29 [INFO] [stdout] 34: 0x5624e4f9dffd - >::set::>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/macros/scoped_tls.rs:61:9 [INFO] [stdout] 35: 0x5624e529b0ac - tokio[e61fd428a8c2bff2]::runtime::basic_scheduler::enter::<>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:323:5 [INFO] [stdout] 36: 0x5624e528abed - >::block_on::>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:202:9 [INFO] [stdout] 37: 0x5624e528cc44 - >::block_on::>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:481:9 [INFO] [stdout] 38: 0x5624e529419c - >::block_on::> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:162:24 [INFO] [stdout] 39: 0x5624e508ea4c - ::block_on::> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/mod.rs:450:46 [INFO] [stdout] 40: 0x5624e527661b - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::updating_expiration [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:175:9 [INFO] [stdout] 41: 0x5624e527652e - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::updating_expiration::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:174:11 [INFO] [stdout] 42: 0x5624e4e6b44e - >::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 43: 0x5624e52f72a3 - >::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 44: 0x5624e52f72a3 - test[eeb9024d9ac7bc83]::__rust_begin_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:577:5 [INFO] [stdout] 45: 0x5624e52f5d6c - + core[ee1ca6415511a9c4]::marker::Send> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 46: 0x5624e52f5d6c - + core[ee1ca6415511a9c4]::marker::Send>> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:346:9 [INFO] [stdout] 47: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panicking::try::do_call:: + core[ee1ca6415511a9c4]::marker::Send>>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:401:40 [INFO] [stdout] 48: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panicking::try::<(), std[77c0456e0eb29f0c]::panic::AssertUnwindSafe + core[ee1ca6415511a9c4]::marker::Send>>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:365:19 [INFO] [stdout] 49: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panic::catch_unwind:: + core[ee1ca6415511a9c4]::marker::Send>>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:433:14 [INFO] [stdout] 50: 0x5624e52f5d6c - test[eeb9024d9ac7bc83]::run_test_in_process [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:600:18 [INFO] [stdout] 51: 0x5624e52f5d6c - test[eeb9024d9ac7bc83]::run_test::run_test_inner::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:492:39 [INFO] [stdout] 52: 0x5624e52d5a32 - test[eeb9024d9ac7bc83]::run_test::run_test_inner::{closure#1} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:519:37 [INFO] [stdout] 53: 0x5624e52d5a32 - std[77c0456e0eb29f0c]::sys_common::backtrace::__rust_begin_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:125:18 [INFO] [stdout] 54: 0x5624e52d6318 - ::spawn_unchecked::::{closure#0}::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/mod.rs:481:17 [INFO] [stdout] 55: 0x5624e52d6318 - ::spawn_unchecked::{closure#0}::{closure#0}> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:346:9 [INFO] [stdout] 56: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panicking::try::do_call::::spawn_unchecked::{closure#0}::{closure#0}>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:401:40 [INFO] [stdout] 57: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panicking::try::<(), std[77c0456e0eb29f0c]::panic::AssertUnwindSafe<::spawn_unchecked::{closure#0}::{closure#0}>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:365:19 [INFO] [stdout] 58: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panic::catch_unwind::::spawn_unchecked::{closure#0}::{closure#0}>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:433:14 [INFO] [stdout] 59: 0x5624e52d6318 - ::spawn_unchecked::::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/mod.rs:480:30 [INFO] [stdout] 60: 0x5624e52d6318 - <::spawn_unchecked::{closure#0} as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 61: 0x5624e56ffed7 - > as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 62: 0x5624e56ffed7 - >> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 63: 0x5624e56ffed7 - ::new::thread_start [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys/unix/thread.rs:71:17 [INFO] [stdout] 64: 0x7f73b4ee2609 - start_thread [INFO] [stdout] 65: 0x7f73b4cb4293 - clone [INFO] [stdout] 66: 0x0 - [INFO] [stdout] [INFO] [stdout] ---- storage::kv::tests::multiple_keys_expiration stdout ---- [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 96.156283ms [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 96.137882ms [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 660.587206ms [INFO] [stdout] thread 'storage::kv::tests::multiple_keys_expiration' panicked at 'assertion failed: tree.get(b\"bkey\")?.is_none()', src/storage/kv.rs:232:17 [INFO] [stdout] stack backtrace: [INFO] [stdout] 0: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::backtrace_rs::backtrace::libunwind::trace [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/../../backtrace/src/backtrace/libunwind.rs:90:5 [INFO] [stdout] 1: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::backtrace_rs::backtrace::trace_unsynchronized:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stdout] 2: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::sys_common::backtrace::_print_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:67:5 [INFO] [stdout] 3: 0x5624e56f73e0 - ::fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:46:22 [INFO] [stdout] 4: 0x5624e571c40c - core[ee1ca6415511a9c4]::fmt::write [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/fmt/mod.rs:1110:17 [INFO] [stdout] 5: 0x5624e56f3825 - as std[77c0456e0eb29f0c]::io::Write>::write_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/io/mod.rs:1584:15 [INFO] [stdout] 6: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::sys_common::backtrace::_print [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:49:5 [INFO] [stdout] 7: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::sys_common::backtrace::print [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:36:9 [INFO] [stdout] 8: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::panicking::default_hook::{closure#1} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:208:50 [INFO] [stdout] 9: 0x5624e56f955c - std[77c0456e0eb29f0c]::panicking::default_hook [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:222:9 [INFO] [stdout] 10: 0x5624e56fa0f1 - std[77c0456e0eb29f0c]::panicking::rust_panic_with_hook [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:622:17 [INFO] [stdout] 11: 0x5624e56f9bc7 - std[77c0456e0eb29f0c]::panicking::begin_panic_handler::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:517:13 [INFO] [stdout] 12: 0x5624e56f78dc - std[77c0456e0eb29f0c]::sys_common::backtrace::__rust_end_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:141:18 [INFO] [stdout] 13: 0x5624e56f9b59 - rust_begin_unwind [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:515:5 [INFO] [stdout] 14: 0x5624e4da6aa1 - core[ee1ca6415511a9c4]::panicking::panic_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/panicking.rs:92:14 [INFO] [stdout] 15: 0x5624e4da69ed - core[ee1ca6415511a9c4]::panicking::panic [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/panicking.rs:50:5 [INFO] [stdout] 16: 0x5624e52795f7 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::multiple_keys_expiration::{closure#0}::{closure#0}::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:232:17 [INFO] [stdout] 17: 0x5624e50c1a89 - as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 18: 0x5624e4fdc280 - > as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/future/maybe_done.rs:68:48 [INFO] [stdout] 19: 0x5624e52705c9 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::run_test::>::{closure#0}::{closure#1} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/macros/join.rs:86:20 [INFO] [stdout] 20: 0x5624e50778a8 - >::{closure#0}::{closure#1}> as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/future/poll_fn.rs:38:9 [INFO] [stdout] 21: 0x5624e52747cd - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::run_test::>::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:148:24 [INFO] [stdout] 22: 0x5624e50bebc9 - >::{closure#0}> as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 23: 0x5624e5279889 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::multiple_keys_expiration::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:208:9 [INFO] [stdout] 24: 0x5624e50c6759 - as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 25: 0x5624e51d055f - > as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/future.rs:120:9 [INFO] [stdout] 26: 0x5624e52bf870 - >::block_on::>>::{closure#0}::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:213:62 [INFO] [stdout] 27: 0x5624e525e2e2 - tokio[e61fd428a8c2bff2]::coop::with_budget::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:106:9 [INFO] [stdout] 28: 0x5624e4ebb0c3 - >>::try_with::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0}, core[ee1ca6415511a9c4]::task::poll::Poll>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/local.rs:400:16 [INFO] [stdout] 29: 0x5624e4eb1c8d - >>::with::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0}, core[ee1ca6415511a9c4]::task::poll::Poll>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/local.rs:376:9 [INFO] [stdout] 30: 0x5624e52b710c - tokio[e61fd428a8c2bff2]::coop::with_budget::>, >::block_on>>::{closure#0}::{closure#0}> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:99:5 [INFO] [stdout] 31: 0x5624e52b710c - tokio[e61fd428a8c2bff2]::coop::budget::>, >::block_on>>::{closure#0}::{closure#0}> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:76:5 [INFO] [stdout] 32: 0x5624e52b710c - >::block_on::>>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:213:39 [INFO] [stdout] 33: 0x5624e52ba7e1 - tokio[e61fd428a8c2bff2]::runtime::basic_scheduler::enter::<>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:323:29 [INFO] [stdout] 34: 0x5624e4f9e1fd - >::set::>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/macros/scoped_tls.rs:61:9 [INFO] [stdout] 35: 0x5624e529b78c - tokio[e61fd428a8c2bff2]::runtime::basic_scheduler::enter::<>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:323:5 [INFO] [stdout] 36: 0x5624e528ac4d - >::block_on::>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:202:9 [INFO] [stdout] 37: 0x5624e528cd84 - >::block_on::>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:481:9 [INFO] [stdout] 38: 0x5624e52949dc - >::block_on::> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:162:24 [INFO] [stdout] 39: 0x5624e508ee2c - ::block_on::> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/mod.rs:450:46 [INFO] [stdout] 40: 0x5624e5277eeb - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::multiple_keys_expiration [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:208:9 [INFO] [stdout] 41: 0x5624e5277dfe - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::multiple_keys_expiration::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:207:11 [INFO] [stdout] 42: 0x5624e4e6b4ce - >::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 43: 0x5624e52f72a3 - >::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 44: 0x5624e52f72a3 - test[eeb9024d9ac7bc83]::__rust_begin_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:577:5 [INFO] [stdout] 45: 0x5624e52f5d6c - + core[ee1ca6415511a9c4]::marker::Send> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 46: 0x5624e52f5d6c - + core[ee1ca6415511a9c4]::marker::Send>> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:346:9 [INFO] [stdout] 47: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panicking::try::do_call:: + core[ee1ca6415511a9c4]::marker::Send>>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:401:40 [INFO] [stdout] 48: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panicking::try::<(), std[77c0456e0eb29f0c]::panic::AssertUnwindSafe + core[ee1ca6415511a9c4]::marker::Send>>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:365:19 [INFO] [stdout] 49: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panic::catch_unwind:: + core[ee1ca6415511a9c4]::marker::Send>>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:433:14 [INFO] [stdout] 50: 0x5624e52f5d6c - test[eeb9024d9ac7bc83]::run_test_in_process [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:600:18 [INFO] [stdout] 51: 0x5624e52f5d6c - test[eeb9024d9ac7bc83]::run_test::run_test_inner::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:492:39 [INFO] [stdout] 52: 0x5624e52d5a32 - test[eeb9024d9ac7bc83]::run_test::run_test_inner::{closure#1} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:519:37 [INFO] [stdout] 53: 0x5624e52d5a32 - std[77c0456e0eb29f0c]::sys_common::backtrace::__rust_begin_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:125:18 [INFO] [stdout] 54: 0x5624e52d6318 - ::spawn_unchecked::::{closure#0}::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/mod.rs:481:17 [INFO] [stdout] 55: 0x5624e52d6318 - ::spawn_unchecked::{closure#0}::{closure#0}> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:346:9 [INFO] [stdout] 56: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panicking::try::do_call::::spawn_unchecked::{closure#0}::{closure#0}>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:401:40 [INFO] [stdout] 57: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panicking::try::<(), std[77c0456e0eb29f0c]::panic::AssertUnwindSafe<::spawn_unchecked::{closure#0}::{closure#0}>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:365:19 [INFO] [stdout] 58: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panic::catch_unwind::::spawn_unchecked::{closure#0}::{closure#0}>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:433:14 [INFO] [stdout] 59: 0x5624e52d6318 - ::spawn_unchecked::::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/mod.rs:480:30 [INFO] [stdout] 60: 0x5624e52d6318 - <::spawn_unchecked::{closure#0} as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 61: 0x5624e56ffed7 - > as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 62: 0x5624e56ffed7 - >> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 63: 0x5624e56ffed7 - ::new::thread_start [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys/unix/thread.rs:71:17 [INFO] [stdout] 64: 0x7f73b4ee2609 - start_thread [INFO] [stdout] 65: 0x7f73b4cb4293 - clone [INFO] [stdout] 66: 0x0 - [INFO] [stdout] [INFO] [stdout] ---- storage::kv::tests::out_of_order_expiration stdout ---- [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 2.998126328s [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 993.404565ms [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 993.379004ms [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 198.580141ms [INFO] [stdout] [src/storage/kv.rs:40] remaining_time = 75.566704ms [INFO] [stdout] thread 'storage::kv::tests::out_of_order_expiration' panicked at 'assertion failed: tree.get(b\"akey\")?.is_some()', src/storage/kv.rs:296:13 [INFO] [stdout] stack backtrace: [INFO] [stdout] 0: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::backtrace_rs::backtrace::libunwind::trace [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/../../backtrace/src/backtrace/libunwind.rs:90:5 [INFO] [stdout] 1: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::backtrace_rs::backtrace::trace_unsynchronized:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stdout] 2: 0x5624e56f73e0 - std[77c0456e0eb29f0c]::sys_common::backtrace::_print_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:67:5 [INFO] [stdout] 3: 0x5624e56f73e0 - ::fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:46:22 [INFO] [stdout] 4: 0x5624e571c40c - core[ee1ca6415511a9c4]::fmt::write [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/fmt/mod.rs:1110:17 [INFO] [stdout] 5: 0x5624e56f3825 - as std[77c0456e0eb29f0c]::io::Write>::write_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/io/mod.rs:1584:15 [INFO] [stdout] 6: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::sys_common::backtrace::_print [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:49:5 [INFO] [stdout] 7: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::sys_common::backtrace::print [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:36:9 [INFO] [stdout] 8: 0x5624e56f9a4b - std[77c0456e0eb29f0c]::panicking::default_hook::{closure#1} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:208:50 [INFO] [stdout] 9: 0x5624e56f955c - std[77c0456e0eb29f0c]::panicking::default_hook [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:222:9 [INFO] [stdout] 10: 0x5624e56fa0f1 - std[77c0456e0eb29f0c]::panicking::rust_panic_with_hook [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:622:17 [INFO] [stdout] 11: 0x5624e56f9bc7 - std[77c0456e0eb29f0c]::panicking::begin_panic_handler::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:517:13 [INFO] [stdout] 12: 0x5624e56f78dc - std[77c0456e0eb29f0c]::sys_common::backtrace::__rust_end_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:141:18 [INFO] [stdout] 13: 0x5624e56f9b59 - rust_begin_unwind [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:515:5 [INFO] [stdout] 14: 0x5624e4da6aa1 - core[ee1ca6415511a9c4]::panicking::panic_fmt [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/panicking.rs:92:14 [INFO] [stdout] 15: 0x5624e4da69ed - core[ee1ca6415511a9c4]::panicking::panic [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/panicking.rs:50:5 [INFO] [stdout] 16: 0x5624e527c9a4 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::out_of_order_expiration::{closure#0}::{closure#0}::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:296:13 [INFO] [stdout] 17: 0x5624e50c19d9 - as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 18: 0x5624e4fdc030 - > as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/future/maybe_done.rs:68:48 [INFO] [stdout] 19: 0x5624e5270349 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::run_test::>::{closure#0}::{closure#1} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/macros/join.rs:86:20 [INFO] [stdout] 20: 0x5624e5077848 - >::{closure#0}::{closure#1}> as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/future/poll_fn.rs:38:9 [INFO] [stdout] 21: 0x5624e527399d - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::run_test::>::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:148:24 [INFO] [stdout] 22: 0x5624e50beb19 - >::{closure#0}> as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 23: 0x5624e527d1e9 - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::out_of_order_expiration::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:274:9 [INFO] [stdout] 24: 0x5624e50c66a9 - as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/mod.rs:80:19 [INFO] [stdout] 25: 0x5624e51d04ef - > as core[ee1ca6415511a9c4]::future::future::Future>::poll [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/future/future.rs:120:9 [INFO] [stdout] 26: 0x5624e52bf710 - >::block_on::>>::{closure#0}::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:213:62 [INFO] [stdout] 27: 0x5624e525e182 - tokio[e61fd428a8c2bff2]::coop::with_budget::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:106:9 [INFO] [stdout] 28: 0x5624e4ebaf53 - >>::try_with::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0}, core[ee1ca6415511a9c4]::task::poll::Poll>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/local.rs:400:16 [INFO] [stdout] 29: 0x5624e4eb1c0d - >>::with::>, >::block_on>>::{closure#0}::{closure#0}>::{closure#0}, core[ee1ca6415511a9c4]::task::poll::Poll>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/local.rs:376:9 [INFO] [stdout] 30: 0x5624e52b661c - tokio[e61fd428a8c2bff2]::coop::with_budget::>, >::block_on>>::{closure#0}::{closure#0}> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:99:5 [INFO] [stdout] 31: 0x5624e52b661c - tokio[e61fd428a8c2bff2]::coop::budget::>, >::block_on>>::{closure#0}::{closure#0}> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/coop.rs:76:5 [INFO] [stdout] 32: 0x5624e52b661c - >::block_on::>>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:213:39 [INFO] [stdout] 33: 0x5624e52ba7a1 - tokio[e61fd428a8c2bff2]::runtime::basic_scheduler::enter::<>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver>::{closure#0} [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:323:29 [INFO] [stdout] 34: 0x5624e4f9e0fd - >::set::>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/macros/scoped_tls.rs:61:9 [INFO] [stdout] 35: 0x5624e529b41c - tokio[e61fd428a8c2bff2]::runtime::basic_scheduler::enter::<>::block_on>>::{closure#0}, core[ee1ca6415511a9c4]::result::Result<(), anyhow[cb590539e965a442]::Error>, tokio[e61fd428a8c2bff2]::runtime::driver::Driver> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:323:5 [INFO] [stdout] 36: 0x5624e528ac1d - >::block_on::>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:202:9 [INFO] [stdout] 37: 0x5624e528cce4 - >::block_on::>> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:481:9 [INFO] [stdout] 38: 0x5624e52945bc - >::block_on::> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/basic_scheduler.rs:162:24 [INFO] [stdout] 39: 0x5624e508ec3c - ::block_on::> [INFO] [stdout] at /opt/rustwide/cargo-home/registry/src/github.com-1ecc6299db9ec823/tokio-1.6.1/src/runtime/mod.rs:450:46 [INFO] [stdout] 40: 0x5624e527ae3b - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::out_of_order_expiration [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:274:9 [INFO] [stdout] 41: 0x5624e527ad4e - pliantdb_local[951f29e80d4a1d9a]::storage::kv::tests::out_of_order_expiration::{closure#0} [INFO] [stdout] at /opt/rustwide/workdir/src/storage/kv.rs:273:11 [INFO] [stdout] 42: 0x5624e4e6b48e - >::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 43: 0x5624e52f72a3 - >::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 44: 0x5624e52f72a3 - test[eeb9024d9ac7bc83]::__rust_begin_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:577:5 [INFO] [stdout] 45: 0x5624e52f5d6c - + core[ee1ca6415511a9c4]::marker::Send> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 46: 0x5624e52f5d6c - + core[ee1ca6415511a9c4]::marker::Send>> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:346:9 [INFO] [stdout] 47: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panicking::try::do_call:: + core[ee1ca6415511a9c4]::marker::Send>>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:401:40 [INFO] [stdout] 48: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panicking::try::<(), std[77c0456e0eb29f0c]::panic::AssertUnwindSafe + core[ee1ca6415511a9c4]::marker::Send>>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:365:19 [INFO] [stdout] 49: 0x5624e52f5d6c - std[77c0456e0eb29f0c]::panic::catch_unwind:: + core[ee1ca6415511a9c4]::marker::Send>>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:433:14 [INFO] [stdout] 50: 0x5624e52f5d6c - test[eeb9024d9ac7bc83]::run_test_in_process [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:600:18 [INFO] [stdout] 51: 0x5624e52f5d6c - test[eeb9024d9ac7bc83]::run_test::run_test_inner::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:492:39 [INFO] [stdout] 52: 0x5624e52d5a32 - test[eeb9024d9ac7bc83]::run_test::run_test_inner::{closure#1} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/test/src/lib.rs:519:37 [INFO] [stdout] 53: 0x5624e52d5a32 - std[77c0456e0eb29f0c]::sys_common::backtrace::__rust_begin_short_backtrace:: [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys_common/backtrace.rs:125:18 [INFO] [stdout] 54: 0x5624e52d6318 - ::spawn_unchecked::::{closure#0}::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/mod.rs:481:17 [INFO] [stdout] 55: 0x5624e52d6318 - ::spawn_unchecked::{closure#0}::{closure#0}> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:346:9 [INFO] [stdout] 56: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panicking::try::do_call::::spawn_unchecked::{closure#0}::{closure#0}>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:401:40 [INFO] [stdout] 57: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panicking::try::<(), std[77c0456e0eb29f0c]::panic::AssertUnwindSafe<::spawn_unchecked::{closure#0}::{closure#0}>> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panicking.rs:365:19 [INFO] [stdout] 58: 0x5624e52d6318 - std[77c0456e0eb29f0c]::panic::catch_unwind::::spawn_unchecked::{closure#0}::{closure#0}>, ()> [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/panic.rs:433:14 [INFO] [stdout] 59: 0x5624e52d6318 - ::spawn_unchecked::::{closure#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/thread/mod.rs:480:30 [INFO] [stdout] 60: 0x5624e52d6318 - <::spawn_unchecked::{closure#0} as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0} [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/core/src/ops/function.rs:227:5 [INFO] [stdout] 61: 0x5624e56ffed7 - > as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 62: 0x5624e56ffed7 - >> as core[ee1ca6415511a9c4]::ops::function::FnOnce<()>>::call_once [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/alloc/src/boxed.rs:1575:9 [INFO] [stdout] 63: 0x5624e56ffed7 - ::new::thread_start [INFO] [stdout] at /rustc/ce59db7a1b1b012fb2793c4641c1bdecad7a128b/library/std/src/sys/unix/thread.rs:71:17 [INFO] [stdout] 64: 0x7f73b4ee2609 - start_thread [INFO] [stdout] 65: 0x7f73b4cb4293 - clone [INFO] [stdout] 66: 0x0 - [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] failures: [INFO] [stdout] storage::kv::tests::multiple_keys_expiration [INFO] [stdout] storage::kv::tests::out_of_order_expiration [INFO] [stdout] storage::kv::tests::updating_expiration [INFO] [stdout] [INFO] [stdout] test result: FAILED. 27 passed; 3 failed; 0 ignored; 0 measured; 0 filtered out; finished in 9.25s [INFO] [stdout] [INFO] [stderr] error: test failed, to rerun pass '--lib' [INFO] running `Command { std: "docker" "inspect" "320109ae5fa05d843f705a00bc9bdd19f898700bab5b89bb5fc4e3cc1962ed49", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "320109ae5fa05d843f705a00bc9bdd19f898700bab5b89bb5fc4e3cc1962ed49", kill_on_drop: false }` [INFO] [stdout] 320109ae5fa05d843f705a00bc9bdd19f898700bab5b89bb5fc4e3cc1962ed49