Nov 02 23:54:24.561 INFO testing cocaine-0.9.2 against beta-2018-10-30 for beta-1.31-1
Nov 02 23:54:24.561 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/beta-1.31-1/worker-3/beta-2018-10-30:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/beta-1.31-1/beta-2018-10-30:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +beta-2018-10-30 build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 02 23:54:24.695 INFO blam! b25cbf26a5cfd372f48fdcd06bb7b9dc80b41e79837794b6cc8748a4a55b9342
Nov 02 23:54:24.695 INFO running `"docker" "start" "-a" "b25cbf26a5cfd372f48fdcd06bb7b9dc80b41e79837794b6cc8748a4a55b9342"`
Nov 02 23:54:25.115 INFO kablam! usermod: no changes
Nov 02 23:54:25.289 INFO kablam!    Compiling rmpv v0.4.0
Nov 02 23:54:27.556 INFO kablam!    Compiling cocaine v0.9.2 (/source)
Nov 02 23:54:37.399 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 12.27s
Nov 02 23:54:37.411 INFO kablam! su: No module specific data is present
Nov 02 23:54:37.993 INFO running `"docker" "rm" "-f" "b25cbf26a5cfd372f48fdcd06bb7b9dc80b41e79837794b6cc8748a4a55b9342"`
Nov 02 23:54:38.240 INFO blam! b25cbf26a5cfd372f48fdcd06bb7b9dc80b41e79837794b6cc8748a4a55b9342
Nov 02 23:54:38.247 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/beta-1.31-1/worker-3/beta-2018-10-30:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/beta-1.31-1/beta-2018-10-30:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +beta-2018-10-30 test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 02 23:54:38.579 INFO blam! 1bf53df48241ad5c0d40e9378d0a3be1b99426c336b9529072dfc053f4b4622d
Nov 02 23:54:38.586 INFO running `"docker" "start" "-a" "1bf53df48241ad5c0d40e9378d0a3be1b99426c336b9529072dfc053f4b4622d"`
Nov 02 23:54:39.658 INFO kablam! usermod: no changes
Nov 02 23:54:39.916 INFO kablam!    Compiling slog-extra v0.1.2
Nov 02 23:54:41.571 INFO kablam!    Compiling slog-stream v1.2.1
Nov 02 23:54:42.719 INFO kablam!    Compiling slog-term v1.5.0
Nov 02 23:54:46.247 INFO kablam!    Compiling slog-stdlog v1.1.0
Nov 02 23:54:48.511 INFO kablam!    Compiling slog-envlogger v0.5.0
Nov 02 23:54:51.673 INFO kablam!    Compiling cocaine v0.9.2 (/source)
Nov 02 23:55:40.885 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 1m 01s
Nov 02 23:55:40.912 INFO kablam! su: No module specific data is present
Nov 02 23:55:41.783 INFO running `"docker" "rm" "-f" "1bf53df48241ad5c0d40e9378d0a3be1b99426c336b9529072dfc053f4b4622d"`
Nov 02 23:55:42.133 INFO blam! 1bf53df48241ad5c0d40e9378d0a3be1b99426c336b9529072dfc053f4b4622d
Nov 02 23:55:42.236 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/beta-1.31-1/worker-3/beta-2018-10-30:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/beta-1.31-1/beta-2018-10-30:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +beta-2018-10-30 test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 02 23:55:42.666 INFO blam! 0a86b1ce6aac316247fec3073cedf176907d3c103083e530e329cb7622caf059
Nov 02 23:55:42.668 INFO running `"docker" "start" "-a" "0a86b1ce6aac316247fec3073cedf176907d3c103083e530e329cb7622caf059"`
Nov 02 23:55:43.411 INFO kablam! usermod: no changes
Nov 02 23:55:43.575 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 0.14s
Nov 02 23:55:43.584 INFO kablam!      Running /target/debug/deps/cocaine-4e3d04dabca2a0dc
Nov 02 23:55:43.588 INFO blam! 
Nov 02 23:55:43.588 INFO blam! running 14 tests
Nov 02 23:55:43.592 INFO blam! test logging::tests::test_macro_with_attribute ... ok
Nov 02 23:55:43.593 INFO blam! test logging::tests::test_macro_with_args_and_attributes ... ok
Nov 02 23:55:43.593 INFO blam! test logging::tests::test_macro_with_attributes ... ok
Nov 02 23:55:43.595 INFO blam! test net::connect::tests::test_connect ... ok
Nov 02 23:55:43.595 INFO blam! test logging::tests::test_macro_with_args ... ok
Nov 02 23:55:43.596 INFO blam! test frame::test::pass ... ok
Nov 02 23:55:43.596 INFO blam! test logging::tests::test_macro_without_args ... ok
Nov 02 23:55:43.596 INFO blam! test net::connect::tests::test_connect_multi ... ok
Nov 02 23:55:43.596 INFO blam! test resolve::test::fixed_resolver_default_addrs ... ok
Nov 02 23:55:43.597 INFO blam! test net::connect::tests::test_connection_refused ... ok
Nov 02 23:55:43.611 INFO blam! test resolve::test::fixed_resolver_saves_addrs ... ok
Nov 02 23:55:43.639 INFO blam! test frame::test::fail_invalid_type_type ... ok
Nov 02 23:55:43.639 INFO blam! test frame::test::fail_invalid_frame_type ... ok
Nov 02 23:55:43.639 INFO blam! test frame::test::fail_invalid_chan_type ... ok
Nov 02 23:55:43.639 INFO blam! 
Nov 02 23:55:43.639 INFO blam! test result: ok. 14 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 02 23:55:43.639 INFO blam! 
Nov 02 23:55:43.640 INFO kablam!      Running /target/debug/deps/service-1fefc6858cc73e73
Nov 02 23:55:43.646 INFO blam! 
Nov 02 23:55:43.646 INFO blam! running 4 tests
Nov 02 23:55:43.651 INFO blam! test connection_refused ... ok
Nov 02 23:55:43.659 INFO blam! test dispatch_receives_rst ... ok
Nov 02 23:55:43.659 INFO blam! test connection_refused_because_invalid_framing ... ok
Nov 02 23:55:43.670 INFO blam! test connect ... ok
Nov 02 23:55:43.671 INFO kablam!    Doc-tests cocaine
Nov 02 23:55:43.671 INFO blam! 
Nov 02 23:55:43.671 INFO blam! test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 02 23:55:43.671 INFO blam! 
Nov 02 23:55:50.133 INFO blam! 
Nov 02 23:55:50.133 INFO blam! running 19 tests
Nov 02 23:56:24.847 INFO blam! test src/logging.rs - cocaine_log (line 371) ... ok
Nov 02 23:56:29.049 INFO blam! test src/logging.rs - cocaine_log (line 354) ... ok
Nov 02 23:56:29.737 INFO blam! test src/lib.rs -  (line 42) ... ok
Nov 02 23:56:32.907 INFO blam! test src/lib.rs -  (line 23) ... ok
Nov 02 23:56:33.123 INFO blam! test src/resolve.rs - resolve::Resolver (line 122) ... ok
Nov 02 23:56:34.559 INFO blam! test src/lib.rs - Service::new (line 1301) ... ok
Nov 02 23:56:35.475 INFO blam! test src/logging.rs - logging::LoggerContext::new (line 178) ... ok
Nov 02 23:56:39.235 INFO blam! test src/request.rs - request::Request (line 16) ... ok
Nov 02 23:57:09.931 INFO blam! test src/response.rs - response::Response<'a, 'b>::deserialize (line 71) ... ok
Nov 02 23:57:18.615 INFO blam! test src/service/locator.rs - service::locator::Locator::resolve (line 48) ... ok
Nov 02 23:57:24.947 INFO blam! test src/service/mod.rs - service::ServiceBuilder (line 82) ... ok
Nov 02 23:57:29.911 INFO blam! test src/service/storage.rs - service::storage::Storage::write (line 60) ... ok
Nov 02 23:57:32.927 INFO blam! test src/service/mod.rs - service::ServiceBuilder<ResolverBuilder>::locator_addrs (line 124) ... test src/service/mod.rs - service::ServiceBuilder<ResolverBuilder>::locator_addrs (line 124) has been running for over 60 seconds
Nov 02 23:57:33.107 INFO blam! test src/service/storage.rs - service::storage::Storage::read (line 31) ... ok
Nov 02 23:57:33.127 INFO blam! test src/service/mod.rs - service::ServiceBuilder<T>::resolver (line 176) ... test src/service/mod.rs - service::ServiceBuilder<T>::resolver (line 176) has been running for over 60 seconds
Nov 02 23:57:34.175 INFO blam! test src/service/mod.rs - service::ServiceBuilder<T>::resolver (line 176) ... ok
Nov 02 23:57:34.959 INFO blam! test src/service/mod.rs - service::ServiceBuilder<ResolverBuilder>::locator_addrs (line 124) ... ok
Nov 02 23:57:35.031 INFO blam! test src/service/unicorn.rs - service::unicorn::Unicorn::create (line 101) ... ok
Nov 02 23:57:43.767 INFO blam! test src/service/unicorn.rs - service::unicorn::Unicorn::del (line 176) ... ok
Nov 02 23:57:45.663 INFO blam! test src/service/unicorn.rs - service::unicorn::Unicorn::get (line 212) ... ok
Nov 02 23:57:47.174 INFO blam! test src/service/unicorn.rs - service::unicorn::Unicorn::put (line 139) ... ok
Nov 02 23:57:47.174 INFO blam! 
Nov 02 23:57:47.174 INFO blam! test result: ok. 19 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 02 23:57:47.174 INFO blam! 
Nov 02 23:57:47.186 INFO kablam! su: No module specific data is present
Nov 02 23:57:48.086 INFO running `"docker" "rm" "-f" "0a86b1ce6aac316247fec3073cedf176907d3c103083e530e329cb7622caf059"`
Nov 02 23:57:48.407 INFO blam! 0a86b1ce6aac316247fec3073cedf176907d3c103083e530e329cb7622caf059
