Oct 16 13:40:02.154 INFO testing dbg-1.0.4 against master#0e07c4281c343e9e15a0a8fca79538ad1a8eb513 for rustdoc-test-static-cling-1
Oct 16 13:40:02.154 INFO running `"docker" "create" "-v" "/mnt/big/crater/./work/local/target-dirs/rustdoc-test-static-cling-1/worker-5/master#0e07c4281c343e9e15a0a8fca79538ad1a8eb513:/target:rw,Z" "-v" "/mnt/big/crater/./work/local/test-source/worker-5/rustdoc-test-static-cling-1/master#0e07c4281c343e9e15a0a8fca79538ad1a8eb513:/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 +0e07c4281c343e9e15a0a8fca79538ad1a8eb513-alt build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Oct 16 13:40:02.478 INFO blam! 67c8a0af8e56b3a45edd8b8dcebed68ae2ca8777e8235be447d1497a7ea4f28c
Oct 16 13:40:02.481 INFO running `"docker" "start" "-a" "67c8a0af8e56b3a45edd8b8dcebed68ae2ca8777e8235be447d1497a7ea4f28c"`
Oct 16 13:40:03.089 INFO kablam! usermod: no changes
Oct 16 13:40:03.156 INFO kablam!    Compiling dbg v1.0.4 (/source)
Oct 16 13:40:04.567 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 1.44s
Oct 16 13:40:04.568 INFO kablam! su: No module specific data is present
Oct 16 13:40:04.935 INFO running `"docker" "rm" "-f" "67c8a0af8e56b3a45edd8b8dcebed68ae2ca8777e8235be447d1497a7ea4f28c"`
Oct 16 13:40:05.059 INFO blam! 67c8a0af8e56b3a45edd8b8dcebed68ae2ca8777e8235be447d1497a7ea4f28c
Oct 16 13:40:05.064 INFO running `"docker" "create" "-v" "/mnt/big/crater/./work/local/target-dirs/rustdoc-test-static-cling-1/worker-5/master#0e07c4281c343e9e15a0a8fca79538ad1a8eb513:/target:rw,Z" "-v" "/mnt/big/crater/./work/local/test-source/worker-5/rustdoc-test-static-cling-1/master#0e07c4281c343e9e15a0a8fca79538ad1a8eb513:/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 +0e07c4281c343e9e15a0a8fca79538ad1a8eb513-alt test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Oct 16 13:40:05.375 INFO blam! f2d12d982540b827ce8a7f170992095133643303adc8ddbd39d76c6ac9f5a844
Oct 16 13:40:05.377 INFO running `"docker" "start" "-a" "f2d12d982540b827ce8a7f170992095133643303adc8ddbd39d76c6ac9f5a844"`
Oct 16 13:40:05.975 INFO kablam! usermod: no changes
Oct 16 13:40:06.007 INFO kablam!    Compiling dbg v1.0.4 (/source)
Oct 16 13:40:08.006 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 2.01s
Oct 16 13:40:08.008 INFO kablam! su: No module specific data is present
Oct 16 13:40:08.265 INFO running `"docker" "rm" "-f" "f2d12d982540b827ce8a7f170992095133643303adc8ddbd39d76c6ac9f5a844"`
Oct 16 13:40:08.363 INFO blam! f2d12d982540b827ce8a7f170992095133643303adc8ddbd39d76c6ac9f5a844
Oct 16 13:40:08.365 INFO running `"docker" "create" "-v" "/mnt/big/crater/./work/local/target-dirs/rustdoc-test-static-cling-1/worker-5/master#0e07c4281c343e9e15a0a8fca79538ad1a8eb513:/target:rw,Z" "-v" "/mnt/big/crater/./work/local/test-source/worker-5/rustdoc-test-static-cling-1/master#0e07c4281c343e9e15a0a8fca79538ad1a8eb513:/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 +0e07c4281c343e9e15a0a8fca79538ad1a8eb513-alt test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Oct 16 13:40:08.598 INFO blam! fecd6921c0261778e4b6f3eecaa6fd65ed6a3737222039fc15ce75979c58aa46
Oct 16 13:40:08.603 INFO running `"docker" "start" "-a" "fecd6921c0261778e4b6f3eecaa6fd65ed6a3737222039fc15ce75979c58aa46"`
Oct 16 13:40:09.194 INFO kablam! usermod: no changes
Oct 16 13:40:09.231 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 0.01s
Oct 16 13:40:09.231 INFO kablam!      Running /target/debug/deps/dbg-8594cc96f13f7030
Oct 16 13:40:09.235 INFO blam! 
Oct 16 13:40:09.235 INFO blam! running 10 tests
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:299]
Oct 16 13:40:09.255 INFO kablam! => n = 4, n <= 1 = false
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:299]
Oct 16 13:40:09.255 INFO kablam! => n = 3, n <= 1 = false
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:299]
Oct 16 13:40:09.255 INFO kablam! => n = 2, n <= 1 = false
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:299]
Oct 16 13:40:09.255 INFO kablam! => n = 1, n <= 1 = true
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:300]
Oct 16 13:40:09.255 INFO kablam! => n = 1, 1 = 1
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:302]
Oct 16 13:40:09.255 INFO kablam! => n = 2, n * factorial(n - 1) = 2
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:302]
Oct 16 13:40:09.255 INFO kablam! => n = 3, n * factorial(n - 1) = 6
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:302]
Oct 16 13:40:09.255 INFO kablam! => n = 4, n * factorial(n - 1) = 24
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:306]
Oct 16 13:40:09.255 INFO kablam! => factorial(4) = 24
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:275]
Oct 16 13:40:09.255 INFO kablam! => n <= 1 = false
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:275]
Oct 16 13:40:09.255 INFO kablam! => n <= 1 = false
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:275]
Oct 16 13:40:09.255 INFO kablam! => n <= 1 = false
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:275]
Oct 16 13:40:09.255 INFO kablam! => n <= 1 = true
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:276]
Oct 16 13:40:09.255 INFO kablam! => 1 = 1
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:278]
Oct 16 13:40:09.255 INFO kablam! => n * factorial(n - 1) = 2
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:278]
Oct 16 13:40:09.255 INFO kablam! => n * factorial(n - 1) = 6
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:278]
Oct 16 13:40:09.255 INFO kablam! => n * factorial(n - 1) = 24
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:282]
Oct 16 13:40:09.255 INFO kablam! => factorial(4) = 24
Oct 16 13:40:09.255 INFO kablam! 
Oct 16 13:40:09.255 INFO kablam! [DEBUGGING, src/lib.rs:261]
Oct 16 13:40:09.256 INFO kablam! => "width" = 1, "height" = 2, "area" = 2
Oct 16 13:40:09.256 INFO kablam! 
Oct 16 13:40:09.256 INFO kablam! [DEBUGGING, src/lib.rs:264]
Oct 16 13:40:09.256 INFO kablam! => "first point" = Point {
Oct 16 13:40:09.256 INFO kablam!     x: 4,
Oct 16 13:40:09.256 INFO kablam!     y: 5
Oct 16 13:40:09.256 INFO kablam! }, "same point" = Point {
Oct 16 13:40:09.256 INFO kablam!     x: 4,
Oct 16 13:40:09.256 INFO kablam!     y: 5
Oct 16 13:40:09.256 INFO kablam! }
Oct 16 13:40:09.256 INFO kablam! 
Oct 16 13:40:09.256 INFO blam! test tests::factorial_multiarg ... ok
Oct 16 13:40:09.256 INFO blam! test tests::factorial_simple ... ok
Oct 16 13:40:09.256 INFO blam! test tests::labels ... ok
Oct 16 13:40:09.274 INFO blam! test tests::factorial_labels ... ok
Oct 16 13:40:09.274 INFO kablam! [DEBUGGING, src/lib.rs:314]
Oct 16 13:40:09.274 INFO blam! test tests::common_use ... ok
Oct 16 13:40:09.274 INFO kablam! => a = 1, panic!() = [DEBUGGING, src/lib.rs:287]
Oct 16 13:40:09.274 INFO blam! test tests::not_debug ... ok
Oct 16 13:40:09.274 INFO kablam! => "are we at the base case?" = false
Oct 16 13:40:09.274 INFO blam! test tests::passthrough ... ok
Oct 16 13:40:09.274 INFO kablam! 
Oct 16 13:40:09.274 INFO blam! test tests::types ... ok
Oct 16 13:40:09.274 INFO kablam! [DEBUGGING, src/lib.rs:287]
Oct 16 13:40:09.274 INFO blam! test tests::panics ... ok
Oct 16 13:40:09.274 INFO kablam! => "are we at the base case?" = false
Oct 16 13:40:09.275 INFO blam! test tests::unit_works ... ok
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO blam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:287]
Oct 16 13:40:09.275 INFO blam! test result: ok. 10 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Oct 16 13:40:09.275 INFO kablam! => "are we at the base case?" = false
Oct 16 13:40:09.275 INFO blam! 
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:287]
Oct 16 13:40:09.275 INFO kablam! => "are we at the base case?" = true
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:288]
Oct 16 13:40:09.275 INFO kablam! => "base value" = 1
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:290]
Oct 16 13:40:09.275 INFO kablam! => "ascending with n * factorial(n - 1)" = 2
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:290]
Oct 16 13:40:09.275 INFO kablam! => "ascending with n * factorial(n - 1)" = 6
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:290]
Oct 16 13:40:09.275 INFO kablam! => "ascending with n * factorial(n - 1)" = 24
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:294]
Oct 16 13:40:09.275 INFO kablam! => factorial(4) = 24
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:234]
Oct 16 13:40:09.275 INFO kablam! => Point{x: 1, y: 2,} = Point {
Oct 16 13:40:09.275 INFO kablam!     x: 1,
Oct 16 13:40:09.275 INFO kablam!     y: 2
Oct 16 13:40:09.275 INFO kablam! }
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:237]
Oct 16 13:40:09.275 INFO kablam! => p = Point {
Oct 16 13:40:09.275 INFO kablam!     x: 4,
Oct 16 13:40:09.275 INFO kablam!     y: 5
Oct 16 13:40:09.275 INFO kablam! }
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:270]
Oct 16 13:40:09.275 INFO kablam! => &a = [<unknown> of type &tests::not_debug::X is !Debug]
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:241]
Oct 16 13:40:09.275 INFO kablam! => 1 + 2 = 3
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:242]
Oct 16 13:40:09.275 INFO kablam! => x + 1 = 4
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:242]
Oct 16 13:40:09.275 INFO kablam! => 3 = 3
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:243]
Oct 16 13:40:09.275 INFO kablam! => y = 7
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:249]
Oct 16 13:40:09.275 INFO kablam! => a = 1
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:250]
Oct 16 13:40:09.275 INFO kablam! => a = 1, b = 2
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:251]
Oct 16 13:40:09.275 INFO kablam! => a = 1, b = 2, a + b = 3
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:255]
Oct 16 13:40:09.275 INFO kablam! => &p = Point {
Oct 16 13:40:09.275 INFO kablam!     x: 4,
Oct 16 13:40:09.275 INFO kablam!     y: 5
Oct 16 13:40:09.275 INFO kablam! }, &q = Point {
Oct 16 13:40:09.275 INFO kablam!     x: 2,
Oct 16 13:40:09.275 INFO kablam!     y: 1
Oct 16 13:40:09.275 INFO kablam! }
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam! [DEBUGGING, src/lib.rs:230]
Oct 16 13:40:09.275 INFO kablam! => () = ()
Oct 16 13:40:09.275 INFO kablam! 
Oct 16 13:40:09.275 INFO kablam!    Doc-tests dbg
Oct 16 13:40:10.264 INFO blam! 
Oct 16 13:40:10.264 INFO blam! running 0 tests
Oct 16 13:40:10.264 INFO blam! 
Oct 16 13:40:10.264 INFO blam! test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Oct 16 13:40:10.264 INFO blam! 
Oct 16 13:40:10.270 INFO kablam! su: No module specific data is present
Oct 16 13:40:10.640 INFO running `"docker" "rm" "-f" "fecd6921c0261778e4b6f3eecaa6fd65ed6a3737222039fc15ce75979c58aa46"`
Oct 16 13:40:10.813 INFO blam! fecd6921c0261778e4b6f3eecaa6fd65ed6a3737222039fc15ce75979c58aa46