Dec 14 14:38:23.960 INFO testing video-timecode-0.5.3 against try#aa49d8ef14939ddec0e34b346b60174a5673d48f for pr-56550
Dec 14 14:38:23.960 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-5/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-56550/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/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 +aa49d8ef14939ddec0e34b346b60174a5673d48f-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"`
Dec 14 14:38:24.467 INFO [stdout] 8a95ac94bd14430dfc65520dd9f549ec6ab517953e1dbae6adbbed5a7819e6eb
Dec 14 14:38:24.469 INFO running `"docker" "start" "-a" "8a95ac94bd14430dfc65520dd9f549ec6ab517953e1dbae6adbbed5a7819e6eb"`
Dec 14 14:38:25.914 INFO [stderr] usermod: no changes
Dec 14 14:38:25.945 INFO [stderr]    Compiling video-timecode v0.5.3 (/source)
Dec 14 14:38:26.576 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.64s
Dec 14 14:38:26.576 INFO [stderr] su: No module specific data is present
Dec 14 14:38:27.007 INFO running `"docker" "inspect" "8a95ac94bd14430dfc65520dd9f549ec6ab517953e1dbae6adbbed5a7819e6eb"`
Dec 14 14:38:27.168 INFO running `"docker" "rm" "-f" "8a95ac94bd14430dfc65520dd9f549ec6ab517953e1dbae6adbbed5a7819e6eb"`
Dec 14 14:38:27.469 INFO [stdout] 8a95ac94bd14430dfc65520dd9f549ec6ab517953e1dbae6adbbed5a7819e6eb
Dec 14 14:38:27.471 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-5/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-56550/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/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 +aa49d8ef14939ddec0e34b346b60174a5673d48f-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"`
Dec 14 14:38:27.771 INFO [stdout] dd2bd4d417107ccf8bcac26e04e31a50da35015b0d2efc2e96e1aceca9ae8b73
Dec 14 14:38:27.775 INFO running `"docker" "start" "-a" "dd2bd4d417107ccf8bcac26e04e31a50da35015b0d2efc2e96e1aceca9ae8b73"`
Dec 14 14:38:28.671 INFO [stderr] usermod: no changes
Dec 14 14:38:28.711 INFO [stderr]    Compiling video-timecode v0.5.3 (/source)
Dec 14 14:38:31.010 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 2.31s
Dec 14 14:38:31.013 INFO [stderr] su: No module specific data is present
Dec 14 14:38:31.640 INFO running `"docker" "inspect" "dd2bd4d417107ccf8bcac26e04e31a50da35015b0d2efc2e96e1aceca9ae8b73"`
Dec 14 14:38:31.904 INFO running `"docker" "rm" "-f" "dd2bd4d417107ccf8bcac26e04e31a50da35015b0d2efc2e96e1aceca9ae8b73"`
Dec 14 14:38:32.176 INFO [stdout] dd2bd4d417107ccf8bcac26e04e31a50da35015b0d2efc2e96e1aceca9ae8b73
Dec 14 14:38:32.192 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-5/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-56550/try#aa49d8ef14939ddec0e34b346b60174a5673d48f:/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 +aa49d8ef14939ddec0e34b346b60174a5673d48f-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"`
Dec 14 14:38:32.604 INFO [stdout] 31c62a236e7e82f6d8820a5eb82a55ba29bbb2d1f6444f03de7e1718c507ba2e
Dec 14 14:38:32.606 INFO running `"docker" "start" "-a" "31c62a236e7e82f6d8820a5eb82a55ba29bbb2d1f6444f03de7e1718c507ba2e"`
Dec 14 14:38:33.208 INFO [stderr] usermod: no changes
Dec 14 14:38:33.243 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.01s
Dec 14 14:38:33.244 INFO [stderr]      Running /target/debug/deps/video_timecode-01ee96921ff9230f
Dec 14 14:38:33.249 INFO [stderr]      Running /target/debug/deps/video_timecode-c842f57938bdd8bb
Dec 14 14:38:33.249 INFO [stdout] 
Dec 14 14:38:33.249 INFO [stdout] running 0 tests
Dec 14 14:38:33.249 INFO [stdout] 
Dec 14 14:38:33.249 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 14 14:38:33.249 INFO [stdout] 
Dec 14 14:38:33.261 INFO [stdout] 
Dec 14 14:38:33.261 INFO [stdout] running 70 tests
Dec 14 14:38:33.261 INFO [stdout] test add_assign_frames_1 ... ok
Dec 14 14:38:33.261 INFO [stdout] test add_assign_frames_1000_df ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_assign_frames_500 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_frames_1 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_frames_1000000_df ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_frames_1000_df ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_assign_frames_negative_5994 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_assign_frames_negative_2997 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_frames_500 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_frames_negative_2997 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_frames_negative_5994 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_timecode_1 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_timecode_1000000_df ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_timecode_1000_df ... ok
Dec 14 14:38:33.262 INFO [stdout] test dropped_timecode_5994 ... ok
Dec 14 14:38:33.262 INFO [stdout] test add_timecode_500 ... ok
Dec 14 14:38:33.262 INFO [stdout] test dropped_timecode_2997 ... ok
Dec 14 14:38:33.262 INFO [stdout] test format_ndf ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2398_with_frames ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2398_with_hours ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2398_with_minutes ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2398_with_seconds ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2398_zero ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_24_with_frames ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_24_zero ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_24_with_hours ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_24_with_minutes ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_24_with_seconds ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_25_with_frames ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_25_with_hours ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_25_with_minutes ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_25_zero ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2997_with_frames ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2997_with_hours ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_25_with_seconds ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2997_zero ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_30_with_frames ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_30_with_hours ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_30_with_seconds ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_30_zero ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_50_with_frames ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_50_with_hours ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_50_with_minutes ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_50_zero ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_5994_with_frames ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2997_with_seconds ... ok
Dec 14 14:38:33.262 INFO [stdout] test frame_number_2997_with_minutes ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_60_with_frames ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_5994_with_minutes ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_50_with_seconds ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_5994_zero ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_5994_with_hours ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_5994_with_seconds ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_60_zero ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_0 ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_0_df_all_semicolon ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_0_df_for_ndf_frame_rate ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_60_with_seconds ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_0_df_one_dot ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_0_df_one_semicolon ... ok
Dec 14 14:38:33.263 INFO [stdout] test format_df ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_0_df_all_dot ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_30_with_minutes ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_1000000_df ... ok
Dec 14 14:38:33.263 INFO [stdout] test subtract_frames_1 ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_60_with_hours ... ok
Dec 14 14:38:33.263 INFO [stdout] test parse_0_df_mixed ... ok
Dec 14 14:38:33.263 INFO [stdout] test frame_number_60_with_minutes ... ok
Dec 14 14:38:33.263 INFO [stdout] test sub_frames_500 ... ok
Dec 14 14:38:33.279 INFO [stdout] test parse_500 ... ok
Dec 14 14:38:33.279 INFO [stderr]    Doc-tests video-timecode
Dec 14 14:38:33.279 INFO [stdout] 
Dec 14 14:38:33.279 INFO [stdout] test result: ok. 70 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 14 14:38:33.279 INFO [stdout] 
Dec 14 14:38:34.025 INFO [stdout] 
Dec 14 14:38:34.025 INFO [stdout] running 10 tests
Dec 14 14:38:36.267 INFO [stdout] test src/lib.rs - Timecode<T>::Err (line 165) ... ok
Dec 14 14:38:36.507 INFO [stdout] test src/lib.rs - Timecode<T> (line 429) ... ok
Dec 14 14:38:36.555 INFO [stdout] test src/lib.rs - Timecode<T> (line 412) ... ok
Dec 14 14:38:38.085 INFO [stdout] test src/lib.rs - Timecode<T> (line 121) ... ok
Dec 14 14:38:38.104 INFO [stdout] test src/lib.rs - Timecode (line 39) ... ok
Dec 14 14:38:38.157 INFO [stdout] test src/lib.rs - Timecode<T> (line 465) ... ok
Dec 14 14:38:38.385 INFO [stdout] test src/lib.rs - Timecode<T> (line 442) ... ok
Dec 14 14:38:38.389 INFO [stdout] test src/lib.rs - Timecode<T> (line 139) ... ok
Dec 14 14:38:38.974 INFO [stdout] test src/lib.rs - Timecode<T>::Err (line 180) ... ok
Dec 14 14:38:39.036 INFO [stdout] test src/lib.rs - Timecode<T>::new (line 77) ... ok
Dec 14 14:38:39.036 INFO [stdout] 
Dec 14 14:38:39.036 INFO [stdout] test result: ok. 10 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 14 14:38:39.036 INFO [stdout] 
Dec 14 14:38:39.060 INFO [stderr] su: No module specific data is present
Dec 14 14:38:39.383 INFO running `"docker" "inspect" "31c62a236e7e82f6d8820a5eb82a55ba29bbb2d1f6444f03de7e1718c507ba2e"`
Dec 14 14:38:39.470 INFO running `"docker" "rm" "-f" "31c62a236e7e82f6d8820a5eb82a55ba29bbb2d1f6444f03de7e1718c507ba2e"`
Dec 14 14:38:39.665 INFO [stdout] 31c62a236e7e82f6d8820a5eb82a55ba29bbb2d1f6444f03de7e1718c507ba2e