[INFO] fetching crate redoubt-chacha 0.1.0-rc.18...
[INFO] testing redoubt-chacha-0.1.0-rc.18 against 1.100.0-beta.1+cargoflags=--release for beta-release-1.100-2
[INFO] extracting crate redoubt-chacha 0.1.0-rc.18 into /workspace/builds/worker-3-tc2/source
[INFO] started tweaking crates.io crate redoubt-chacha 0.1.0-rc.18
[INFO] finished tweaking crates.io crate redoubt-chacha 0.1.0-rc.18
[INFO] tweaked toml for crates.io crate redoubt-chacha 0.1.0-rc.18 written to /workspace/builds/worker-3-tc2/source/Cargo.toml
[INFO] validating manifest of crates.io crate redoubt-chacha 0.1.0-rc.18 on toolchain 1.100.0-beta.1
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.100.0-beta.1" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate crates.io crate redoubt-chacha 0.1.0-rc.18 already has a lockfile, it will not be regenerated
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.100.0-beta.1" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc2/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc2/target:/opt/rustwide/target:rw,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" "-m" "1610612736" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:77db811e55d90add9212f6832c23229e3de5f1c1f9905e8cb07319ea15df73ac" "sleep" "infinity", kill_on_drop: false }`
[INFO] [stdout] 6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2
[INFO] running `Command { std: "docker" "start" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-w" "/opt/rustwide/workdir" "--user" "0:0" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "build" "--frozen" "--message-format=json" "--release", kill_on_drop: false }`
[INFO] [stderr]    Compiling find-msvc-tools v0.1.6
[INFO] [stderr]    Compiling proc-macro2 v1.0.104
[INFO] [stderr]    Compiling quote v1.0.42
[INFO] [stderr]    Compiling redoubt-asm v0.1.0-rc.18
[INFO] [stderr]    Compiling winnow v0.7.14
[INFO] [stderr]    Compiling toml_datetime v0.7.5+spec-1.1.0
[INFO] [stderr]    Compiling indexmap v2.12.1
[INFO] [stderr]    Compiling cc v1.2.51
[INFO] [stderr]    Compiling syn v2.0.111
[INFO] [stderr]    Compiling redoubt-mem-core v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-chacha v0.1.0-rc.18 (/opt/rustwide/workdir)
[INFO] [stderr]    Compiling redoubt-mem v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-util v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-zero-core v0.1.0-rc.18
[INFO] [stderr]    Compiling toml_parser v1.0.6+spec-1.1.0
[INFO] [stderr]    Compiling toml_edit v0.23.10+spec-1.0.0
[INFO] [stderr]    Compiling thiserror-impl v2.0.17
[INFO] [stderr]    Compiling proc-macro-crate v3.4.0
[INFO] [stderr]    Compiling redoubt-zero-derive v0.1.0-rc.18
[INFO] [stderr]    Compiling thiserror v2.0.17
[INFO] [stderr]    Compiling redoubt-zero v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-aead-core v0.1.0-rc.18
[INFO] [stderr]     Finished `release` profile [optimized] target(s) in 8.76s
[INFO] running `Command { std: "docker" "inspect" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "test" "--frozen" "--no-run" "--message-format=json" "--release", kill_on_drop: false }`
[INFO] [stderr]    Compiling libc v0.2.178
[INFO] [stderr]    Compiling rustix v1.1.3
[INFO] [stderr]    Compiling zerocopy v0.8.31
[INFO] [stderr]    Compiling aho-corasick v1.1.4
[INFO] [stderr]    Compiling regex-syntax v0.8.8
[INFO] [stderr]    Compiling linux-raw-sys v0.11.0
[INFO] [stderr]    Compiling num-traits v0.2.19
[INFO] [stderr]    Compiling rstest_macros v0.27.0
[INFO] [stderr]    Compiling redoubt-forensics-core v0.1.0-rc.18
[INFO] [stderr]    Compiling once_cell v1.21.3
[INFO] [stderr]    Compiling syn v2.0.111
[INFO] [stderr]    Compiling futures-core v0.3.31
[INFO] [stderr]    Compiling relative-path v1.9.3
[INFO] [stderr]    Compiling futures-task v0.3.31
[INFO] [stderr]    Compiling quiesce v0.0.1
[INFO] [stderr]    Compiling futures-timer v3.0.4
[INFO] [stderr]    Compiling redoubt-forensics-allocator v0.1.0-rc.18
[INFO] [stderr]    Compiling futures-util v0.3.31
[INFO] [stderr]    Compiling getrandom v0.3.4
[INFO] [stderr]    Compiling wait-timeout v0.2.1
[INFO] [stderr]    Compiling rand_core v0.9.3
[INFO] [stderr]    Compiling rand_xorshift v0.4.0
[INFO] [stderr]    Compiling rand v0.9.5
[INFO] [stderr]    Compiling regex-automata v0.4.13
[INFO] [stderr]    Compiling ppv-lite86 v0.2.21
[INFO] [stderr]    Compiling tempfile v3.24.0
[INFO] [stderr]    Compiling rand_chacha v0.9.0
[INFO] [stderr]    Compiling rusty-fork v0.3.1
[INFO] [stderr]    Compiling proptest v1.9.0
[INFO] [stderr]    Compiling regex v1.12.2
[INFO] [stderr]    Compiling thiserror-impl v2.0.17
[INFO] [stderr]    Compiling redoubt-zero-derive v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-forensics-macros v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-forensics v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-zero v0.1.0-rc.18
[INFO] [stderr]    Compiling thiserror v2.0.17
[INFO] [stderr]    Compiling redoubt-aead-core v0.1.0-rc.18
[INFO] [stderr]    Compiling redoubt-chacha v0.1.0-rc.18 (/opt/rustwide/workdir)
[INFO] [stderr]    Compiling rstest v0.27.0
[INFO] [stderr]     Finished `release` profile [optimized] target(s) in 29.35s
[INFO] running `Command { std: "docker" "inspect" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "test" "--frozen" "--release", kill_on_drop: false }`
[INFO] [stderr]     Finished `release` profile [optimized] target(s) in 0.13s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/release/build/redoubt-chacha/07ef58c1ccdd125a/out/redoubt_chacha-07ef58c1ccdd125a)
[INFO] [stdout] 
[INFO] [stdout] running 140 tests
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_r8_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_no_offset_expects_an_empty_window ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_rcx_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_rsi_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_a_frame_written_and_emptied_reads_as_empty ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_an_empty_register_file_reads_as_empty ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_rounds_leaves_the_residue_its_case_declares::case_2_frame_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_rounds_leaves_the_residue_its_case_declares::case_3_nothing_ran ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_rounds_leaves_the_residue_its_case_declares::case_1_registers_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_rounds_leaves_the_residue_its_case_declares::case_4_real ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_subkey_leaves_the_residue_its_case_declares::case_3_nothing_ran ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_subkey_leaves_the_residue_its_case_declares::case_1_registers_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_a_byte_left_anywhere_in_the_frame_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_subkey_leaves_the_residue_its_case_declares::case_2_frame_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_the_measurement_of_xor_reads_the_window_the_writer_filled ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_the_measurement_of_xxor_reads_the_window_the_writer_filled ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xor_leaves_the_residue_its_case_declares::case_1_registers_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xor_leaves_the_residue_its_case_declares::case_2_frame_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_r11_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_rdi_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xxor_leaves_the_residue_its_case_declares::case_1_registers_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xxor_leaves_the_residue_its_case_declares::case_2_frame_left_full ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xxor_leaves_the_residue_its_case_declares::case_3_nothing_ran ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xxor_leaves_the_residue_its_case_declares::case_4_real ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_r9_is_seen ... ok
[INFO] [stdout] test tests::backend::helpers::test_check_counter_accepts_an_empty_message_on_the_ceiling ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_the_measurement_of_rounds_reads_the_window_the_writer_filled ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_r10_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_dirty_frame_clears_every_byte_except_the_requested_one ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_the_measurement_of_subkey_reads_the_window_the_writer_filled ... ok
[INFO] [stdout] test tests::backend::rust::test_chacha20_is_zeroizable ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xor_leaves_the_residue_its_case_declares::case_4_real ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_rax_is_seen ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_dirty_registers_fills_every_register_in_the_budget ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_subkey_leaves_the_residue_its_case_declares::case_4_real ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_the_list_names_as_many_registers_as_there_are_tests ... ok
[INFO] [stdout] test tests::backend::asm::test_xor_rejects_a_nonce_width_the_assembly_cannot_read ... ok
[INFO] [stdout] test tests::backend::helpers::test_check_counter_accepts_a_message_that_ends_on_the_ceiling ... ok
[INFO] [stdout] test tests::backend::rust::test_xchacha20_zeroizes_on_drop ... ok
[INFO] [stdout] test tests::backend::helpers::test_check_counter_rejects_a_counter_past_the_ceiling ... ok
[INFO] [stdout] test tests::backend::rust::test_hchacha20_is_zeroizable ... ok
[INFO] [stdout] test tests::backend::rust::test_hchacha20_zeroizes_on_drop ... ok
[INFO] [stdout] test tests::backend::rust::test_xchacha20_is_zeroizable ... ok
[INFO] [stdout] test tests::backend::helpers::test_check_counter_rejects_a_message_that_outruns_what_is_left ... ok
[INFO] [stdout] test tests::backend::helpers::test_last_counter_returns_the_bernstein_ceiling_for_eight_bytes ... ok
[INFO] [stdout] test tests::backend::helpers::test_last_counter_returns_the_rfc_ceiling_for_twelve_bytes ... ok
[INFO] [stdout] test tests::backend::rust::test_chacha20_zeroizes_on_drop ... ok
[INFO] [stdout] test tests::backend::seam::test_rounds_returns_the_published_intermediate_state::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::test_rounds_returns_the_published_intermediate_state::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_advances_one_counter_per_block::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::subkey::test_subkey_overwrites_only_the_output_at_every_alignment::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::test_rounds_returns_what_the_oracle_returns ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_returns_the_plaintext_when_it_is_run_twice::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::subkey::test_subkey_overwrites_only_the_output_at_every_alignment::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::subkey::test_subkey_returns_the_published_subkey::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_accepts_the_last_counter::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_advances_one_counter_per_block::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_accepts_the_last_counter::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::subkey::test_subkey_returns_what_the_oracle_returns ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_returns_the_plaintext_when_it_is_run_twice::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_rejects_counter_exhaustion_before_touching_data::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::subkey::test_subkey_returns_the_published_subkey::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_returns_the_published_ciphertext::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_rejects_counter_exhaustion_before_touching_data::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_rejects_counter_exhaustion_before_touching_data::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_accepts_the_last_counter::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_carries_without_changing_the_nonce::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_carries_without_changing_the_nonce::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_rejects_counter_exhaustion_before_touching_data::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_returns_the_published_ciphertext::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_accepts_the_last_counter::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_returns_the_published_blocks::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_accepts_the_last_counter::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_returns_the_published_blocks::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_accepts_the_last_counter::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_rejects_counter_exhaustion_before_touching_data::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_rejects_counter_exhaustion_before_touching_data::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_returns_the_published_ciphertext::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_returns_the_published_ciphertext::case_2_auto ... ok
[INFO] [stdout] test tests::backend::test_this_target_has_the_assembly ... ok
[INFO] [stdout] test tests::chacha20::test_xor_bernstein_returns_the_published_block::case_1_rust ... ok
[INFO] [stdout] test tests::forensics::chacha20::test_making_one_leaves_nothing ... ignored, Reads no secret: it holds nothing.
[INFO] [stdout] test tests::chacha20::test_xor_bernstein_returns_the_published_block::case_2_auto ... ok
[INFO] [stdout] test tests::chacha20::test_xor_returns_the_published_ciphertext::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_touches_only_the_named_bytes_at_every_alignment::case_2_auto ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_touches_only_the_named_bytes_at_every_alignment::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_touches_only_the_named_bytes_at_every_alignment::case_2_auto ... ok
[INFO] [stdout] test tests::backend::asm::probes::test_xor_leaves_the_residue_its_case_declares::case_3_nothing_ran ... ok
[INFO] [stdout] test tests::chacha20::test_xor_returns_the_published_ciphertext::case_2_auto ... ok
[INFO] [stdout] test tests::backend::asm::probes::every_register::test_rdx_is_seen ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_touches_only_the_named_bytes_at_every_alignment::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_returns_what_the_oracle_returns ... ok
[INFO] [stdout] test tests::backend::seam::xor::test_xor_under_an_eight_byte_nonce_returns_what_the_oracle_returns ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_touches_only_the_named_bytes_at_every_alignment::case_2_auto ... ok
[INFO] [stdout] test tests::forensics::hchacha20::test_making_one_leaves_nothing ... ignored, Reads no secret: it holds nothing.
[INFO] [stdout] test tests::forensics::xchacha20::test_making_one_leaves_nothing ... ignored, Reads no secret: it holds nothing.
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_touches_only_the_named_bytes_at_every_alignment::case_1_rust ... ok
[INFO] [stdout] test tests::backend::seam::xxor::test_xxor_returns_what_the_oracle_returns ... ok
[INFO] [stdout] test tests::hchacha20::test_subkey_returns_the_published_subkey::case_1_rust ... ok
[INFO] [stdout] test tests::hchacha20::test_subkey_returns_the_published_subkey::case_2_auto ... ok
[INFO] [stdout] test tests::rfc::test_xor_returns_the_published_ciphertexts::case_1_rust ... ok
[INFO] [stdout] test tests::rfc::test_xor_returns_the_published_ciphertexts::case_2_auto ... ok
[INFO] [stdout] test tests::rfc::test_xor_returns_the_published_keystream_block::case_1_rust ... ok
[INFO] [stdout] test tests::rfc::test_xor_returns_the_published_keystream_block::case_2_auto ... ok
[INFO] [stdout] test tests::rfc::test_xor_returns_the_published_one_time_key::case_1_rust ... ok
[INFO] [stdout] test tests::rfc::test_xor_returns_the_published_one_time_key::case_2_auto ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_columns_returns_the_published_quarter_round ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_rounds_returns_the_published_intermediate_state ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_state_returns_the_published_initial_state ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_subkey_returns_the_published_subkey ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_accepts_empty_input_at_the_last_counter::case_1_ietf ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_accepts_empty_input_at_the_last_counter::case_2_bernstein ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_bernstein_carries_into_the_high_counter_word ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_bernstein_places_the_high_counter_word_in_the_published_state ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_returns_every_prefix_of_the_published_ciphertext ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_returns_the_published_block ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_returns_the_published_ciphertext ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_returns_the_published_zero_block::case_1_ietf ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xor_returns_the_published_zero_block::case_2_bernstein ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xxor_returns_every_prefix_of_the_published_ciphertext::case_1_counter_zero ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xxor_returns_every_prefix_of_the_published_ciphertext::case_2_counter_one ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xxor_returns_the_published_ciphertext::case_1_counter_zero ... ok
[INFO] [stdout] test tests::support::oracle::tests::test_xxor_returns_the_published_ciphertext::case_2_counter_one ... ok
[INFO] [stdout] test tests::xchacha20::test_xor_returns_the_published_ciphertext_at_the_counter_named::case_1_rust ... ok
[INFO] [stdout] test tests::xchacha20::test_xor_returns_the_published_ciphertext_at_the_counter_named::case_2_auto ... ok
[INFO] [stdout] test tests::forensics::chacha20::test_what_xor_bernstein_decrypted_is_found_while_the_buffer_holds_it ... ok
[INFO] [stdout] test tests::forensics::chacha20::test_what_xor_encrypted_is_found_while_the_buffer_holds_it ... ok
[INFO] [stdout] test tests::forensics::chacha20::test_what_xor_bernstein_encrypted_is_found_while_the_buffer_holds_it ... ok
[INFO] [stdout] test tests::forensics::chacha20::test_what_xor_decrypted_is_found_while_the_buffer_holds_it ... ok
[INFO] [stdout] test tests::forensics::xchacha20::test_what_xor_encrypted_is_found_while_the_buffer_holds_it ... ok
[INFO] [stdout] test tests::forensics::xchacha20::test_what_xor_decrypted_is_found_while_the_buffer_holds_it ... ok
[INFO] [stdout] test tests::forensics::xchacha20::test_the_subkey_xor_derives_is_found_while_a_derivation_holds_it ... ok
[INFO] [stdout] test tests::forensics::hchacha20::test_what_subkey_wrote_is_found_while_the_caller_holds_it ... ok
[INFO] [stdout] test tests::forensics::hchacha20::test_subkey_leaves_nothing ... FAILED
[INFO] [stdout] test tests::forensics::chacha20::test_xor_encrypting_leaves_nothing ... FAILED
[INFO] [stdout] test tests::forensics::chacha20::test_xor_bernstein_decrypting_leaves_nothing ... FAILED
[INFO] [stdout] test tests::forensics::chacha20::test_xor_decrypting_leaves_nothing ... FAILED
[INFO] [stdout] test tests::forensics::chacha20::test_xor_bernstein_encrypting_leaves_nothing ... FAILED
[INFO] [stdout] test tests::forensics::xchacha20::test_xor_encrypting_leaves_nothing ... FAILED
[INFO] [stdout] test tests::forensics::xchacha20::test_xor_decrypting_leaves_nothing ... FAILED
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout] 
[INFO] [stdout] ---- tests::forensics::hchacha20::test_subkey_leaves_nothing stdout ----
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score          223  widest    32  runs         646623  swept      23316464  whole yes
[INFO] [stdout]   subkey, of the key           score            0  widest     3  runs         742452  swept      31672304  whole no
[INFO] [stdout]                                score          -223  widest    -29  runs          +95829  swept       +8355840
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score          219  widest    32  runs         655326  swept      23316464  whole yes
[INFO] [stdout]   subkey, of the subkey        score          219  widest    32  runs         750341  swept      31672304  whole yes
[INFO] [stdout]                                score            +0  widest     +0  runs          +95015  swept       +8355840
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::forensics::hchacha20::test_subkey_leaves_nothing' (1480) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/redoubt-forensics-core-0.1.0-rc.18/src/verdicts.rs:55:5:
[INFO] [stdout] the whole secret was left behind by subkey, of the subkey: score          219  widest    32  runs         750341  swept      31672304  whole yes
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x59861b170901 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]    1:     0x59861b18614a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    2:     0x59861b174f7c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]    3:     0x59861b14b8c6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]    4:     0x59861b168cc9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]    5:     0x59861b0ead70 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]    6:     0x59861b168e82 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]    7:     0x59861b14b972 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]    8:     0x59861b144539 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]    9:     0x59861b14c45d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]   10:     0x59861b1868ac - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]   11:     0x59861b1344e8 - redoubt_forensics_core[32e8484f8a33e1c3]::verdicts::leaves_nothing
[INFO] [stdout]   12:     0x59861b13328b - <redoubt_forensics_core[32e8484f8a33e1c3]::watching::Watching>::none_left
[INFO] [stdout]   13:     0x59861b0bd9e3 - <redoubt_chacha[71c0fe0a4e6b5197]::tests::forensics::hchacha20::test_subkey_leaves_nothing::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]   14:     0x59861b0de1bb - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]   15:     0x59861b0eb395 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]   16:     0x59861b0e4c84 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]   17:     0x59861b0ee422 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]   18:     0x59861b17015f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]   19:     0x70549a48cdfa - <unknown>
[INFO] [stdout]   20:     0x70549a5203d4 - clone
[INFO] [stdout]   21:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- tests::forensics::chacha20::test_xor_encrypting_leaves_nothing stdout ----
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score          223  widest    32  runs         620633  swept      20934800  whole yes
[INFO] [stdout]   xor, encrypting, of the key  score            0  widest     3  runs         742588  swept      36868240  whole no
[INFO] [stdout]                                score          -223  widest    -29  runs         +121955  swept      +15933440
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score        18237  widest  1024  runs       20717332  swept      20934800  whole yes
[INFO] [stdout]   xor, encrypting, of the plaintext score        18234  widest  1024  runs       36609938  swept      36868240  whole yes
[INFO] [stdout]                                score            -3  widest     +0  runs       +15892606  swept      +15933440
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::forensics::chacha20::test_xor_encrypting_leaves_nothing' (1479) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/redoubt-forensics-core-0.1.0-rc.18/src/verdicts.rs:55:5:
[INFO] [stdout] the whole secret was left behind by xor, encrypting, of the plaintext: score        18234  widest  1024  runs       36609938  swept      36868240  whole yes
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x59861b170901 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]    1:     0x59861b18614a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    2:     0x59861b174f7c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]    3:     0x59861b14b8c6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]    4:     0x59861b168cc9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]    5:     0x59861b0ead70 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]    6:     0x59861b168e82 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]    7:     0x59861b14b972 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]    8:     0x59861b144539 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]    9:     0x59861b14c45d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]   10:     0x59861b1868ac - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]   11:     0x59861b1344e8 - redoubt_forensics_core[32e8484f8a33e1c3]::verdicts::leaves_nothing
[INFO] [stdout]   12:     0x59861b13328b - <redoubt_forensics_core[32e8484f8a33e1c3]::watching::Watching>::none_left
[INFO] [stdout]   13:     0x59861b0c61fe - <redoubt_chacha[71c0fe0a4e6b5197]::tests::forensics::chacha20::test_xor_encrypting_leaves_nothing::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]   14:     0x59861b0de1bb - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]   15:     0x59861b0eb395 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]   16:     0x59861b0e4c84 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]   17:     0x59861b0ee422 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]   18:     0x59861b17015f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]   19:     0x70549a48cdfa - <unknown>
[INFO] [stdout]   20:     0x70549a5203d4 - clone
[INFO] [stdout]   21:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- tests::forensics::chacha20::test_xor_bernstein_decrypting_leaves_nothing stdout ----
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score          223  widest    32  runs         617045  swept      20897936  whole yes
[INFO] [stdout]   xor_bernstein, decrypting, of the key score            0  widest     3  runs         743661  swept      47260112  whole no
[INFO] [stdout]                                score          -223  widest    -29  runs         +126616  swept      +26362176
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score        18237  widest  1024  runs       20681715  swept      20897936  whole yes
[INFO] [stdout]   xor_bernstein, decrypting, of the plaintext score        18234  widest  1024  runs       47001534  swept      47260112  whole yes
[INFO] [stdout]                                score            -3  widest     +0  runs       +26319819  swept      +26362176
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::forensics::chacha20::test_xor_bernstein_decrypting_leaves_nothing' (1476) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/redoubt-forensics-core-0.1.0-rc.18/src/verdicts.rs:55:5:
[INFO] [stdout] the whole secret was left behind by xor_bernstein, decrypting, of the plaintext: score        18234  widest  1024  runs       47001534  swept      47260112  whole yes
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x59861b170901 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]    1:     0x59861b18614a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    2:     0x59861b174f7c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]    3:     0x59861b14b8c6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]    4:     0x59861b168cc9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]    5:     0x59861b0ead70 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]    6:     0x59861b168e82 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]    7:     0x59861b14b972 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]    8:     0x59861b144539 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]    9:     0x59861b14c45d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]   10:     0x59861b1868ac - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]   11:     0x59861b1344e8 - redoubt_forensics_core[32e8484f8a33e1c3]::verdicts::leaves_nothing
[INFO] [stdout]   12:     0x59861b13328b - <redoubt_forensics_core[32e8484f8a33e1c3]::watching::Watching>::none_left
[INFO] [stdout]   13:     0x59861b0c6b61 - <redoubt_chacha[71c0fe0a4e6b5197]::tests::forensics::chacha20::test_xor_bernstein_decrypting_leaves_nothing::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]   14:     0x59861b0de1bb - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]   15:     0x59861b0eb395 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]   16:     0x59861b0e4c84 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]   17:     0x59861b0ee422 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]   18:     0x59861b17015f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]   19:     0x70549a48cdfa - <unknown>
[INFO] [stdout]   20:     0x70549a5203d4 - clone
[INFO] [stdout]   21:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- tests::forensics::chacha20::test_xor_decrypting_leaves_nothing stdout ----
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score            0  widest     3  runs         601675  swept      18606384  whole no
[INFO] [stdout]   xor, decrypting, of the key  score            0  widest     3  runs         743670  swept      45162960  whole no
[INFO] [stdout]                                score            +0  widest     +0  runs         +141995  swept      +26556576
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score        18237  widest  1024  runs       18395292  swept      18606384  whole yes
[INFO] [stdout]   xor, decrypting, of the plaintext score        18234  widest  1024  runs       44904383  swept      45162960  whole yes
[INFO] [stdout]                                score            -3  widest     +0  runs       +26509091  swept      +26556576
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::forensics::chacha20::test_xor_decrypting_leaves_nothing' (1478) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/redoubt-forensics-core-0.1.0-rc.18/src/verdicts.rs:55:5:
[INFO] [stdout] the whole secret was left behind by xor, decrypting, of the plaintext: score        18234  widest  1024  runs       44904383  swept      45162960  whole yes
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x59861b170901 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]    1:     0x59861b18614a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    2:     0x59861b174f7c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]    3:     0x59861b14b8c6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]    4:     0x59861b168cc9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]    5:     0x59861b0ead70 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]    6:     0x59861b168e82 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]    7:     0x59861b14b972 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]    8:     0x59861b144539 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]    9:     0x59861b14c45d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]   10:     0x59861b1868ac - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]   11:     0x59861b1344e8 - redoubt_forensics_core[32e8484f8a33e1c3]::verdicts::leaves_nothing
[INFO] [stdout]   12:     0x59861b13328b - <redoubt_forensics_core[32e8484f8a33e1c3]::watching::Watching>::none_left
[INFO] [stdout]   13:     0x59861b0c58b1 - <redoubt_chacha[71c0fe0a4e6b5197]::tests::forensics::chacha20::test_xor_decrypting_leaves_nothing::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]   14:     0x59861b0de1bb - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]   15:     0x59861b0eb395 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]   16:     0x59861b0e4c84 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]   17:     0x59861b0ee422 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]   18:     0x59861b17015f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]   19:     0x70549a48cdfa - <unknown>
[INFO] [stdout]   20:     0x70549a5203d4 - clone
[INFO] [stdout]   21:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- tests::forensics::chacha20::test_xor_bernstein_encrypting_leaves_nothing stdout ----
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score            0  widest     3  runs         632276  swept      21045392  whole no
[INFO] [stdout]   xor_bernstein, encrypting, of the key score            0  widest     3  runs         744647  swept      51458512  whole no
[INFO] [stdout]                                score            +0  widest     +0  runs         +112371  swept      +30413120
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score        18237  widest  1024  runs       20823930  swept      21045392  whole yes
[INFO] [stdout]   xor_bernstein, encrypting, of the plaintext score        18234  widest  1024  runs       51199750  swept      51458512  whole yes
[INFO] [stdout]                                score            -3  widest     +0  runs       +30375820  swept      +30413120
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::forensics::chacha20::test_xor_bernstein_encrypting_leaves_nothing' (1477) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/redoubt-forensics-core-0.1.0-rc.18/src/verdicts.rs:55:5:
[INFO] [stdout] the whole secret was left behind by xor_bernstein, encrypting, of the plaintext: score        18234  widest  1024  runs       51199750  swept      51458512  whole yes
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x59861b170901 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]    1:     0x59861b18614a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    2:     0x59861b174f7c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]    3:     0x59861b14b8c6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]    4:     0x59861b168cc9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]    5:     0x59861b0ead70 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]    6:     0x59861b168e82 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]    7:     0x59861b14b972 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]    8:     0x59861b144539 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]    9:     0x59861b14c45d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]   10:     0x59861b1868ac - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]   11:     0x59861b1344e8 - redoubt_forensics_core[32e8484f8a33e1c3]::verdicts::leaves_nothing
[INFO] [stdout]   12:     0x59861b13328b - <redoubt_forensics_core[32e8484f8a33e1c3]::watching::Watching>::none_left
[INFO] [stdout]   13:     0x59861b0c74ae - <redoubt_chacha[71c0fe0a4e6b5197]::tests::forensics::chacha20::test_xor_bernstein_encrypting_leaves_nothing::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]   14:     0x59861b0de1bb - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]   15:     0x59861b0eb395 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]   16:     0x59861b0e4c84 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]   17:     0x59861b0ee422 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]   18:     0x59861b17015f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]   19:     0x70549a48cdfa - <unknown>
[INFO] [stdout]   20:     0x70549a5203d4 - clone
[INFO] [stdout]   21:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- tests::forensics::xchacha20::test_xor_encrypting_leaves_nothing stdout ----
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score            0  widest     3  runs         709659  swept      26025808  whole no
[INFO] [stdout]   xor, encrypting, of the key  score            0  widest     3  runs         744219  swept      49361360  whole no
[INFO] [stdout]                                score            +0  widest     +0  runs          +34560  swept      +23335552
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score        18237  widest  1024  runs       25776131  swept      26025808  whole yes
[INFO] [stdout]   xor, encrypting, of the plaintext score        18234  widest  1024  runs       49102691  swept      49361360  whole yes
[INFO] [stdout]                                score            -3  widest     +0  runs       +23326560  swept      +23335552
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::forensics::xchacha20::test_xor_encrypting_leaves_nothing' (1499) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/redoubt-forensics-core-0.1.0-rc.18/src/verdicts.rs:55:5:
[INFO] [stdout] the whole secret was left behind by xor, encrypting, of the plaintext: score        18234  widest  1024  runs       49102691  swept      49361360  whole yes
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x59861b170901 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]    1:     0x59861b18614a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    2:     0x59861b174f7c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]    3:     0x59861b14b8c6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]    4:     0x59861b168cc9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]    5:     0x59861b0ead70 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]    6:     0x59861b168e82 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]    7:     0x59861b14b972 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]    8:     0x59861b144539 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]    9:     0x59861b14c45d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]   10:     0x59861b1868ac - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]   11:     0x59861b1344e8 - redoubt_forensics_core[32e8484f8a33e1c3]::verdicts::leaves_nothing
[INFO] [stdout]   12:     0x59861b13328b - <redoubt_forensics_core[32e8484f8a33e1c3]::watching::Watching>::none_left
[INFO] [stdout]   13:     0x59861b0c073e - <redoubt_chacha[71c0fe0a4e6b5197]::tests::forensics::xchacha20::test_xor_encrypting_leaves_nothing::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]   14:     0x59861b0de1bb - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]   15:     0x59861b0eb395 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]   16:     0x59861b0e4c84 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]   17:     0x59861b0ee422 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]   18:     0x59861b17015f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]   19:     0x70549a48cdfa - <unknown>
[INFO] [stdout]   20:     0x70549a5203d4 - clone
[INFO] [stdout]   21:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- tests::forensics::xchacha20::test_xor_decrypting_leaves_nothing stdout ----
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score          223  widest    32  runs         635846  swept      23197680  whole yes
[INFO] [stdout]   xor, decrypting, of the key  score            0  widest     3  runs         746059  swept      56666736  whole no
[INFO] [stdout]                                score          -223  widest    -29  runs         +110213  swept      +33469056
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout]   nothing held yet             score        18237  widest  1024  runs       22975014  swept      23197680  whole yes
[INFO] [stdout]   xor, decrypting, of the plaintext score        18234  widest  1024  runs       56407669  swept      56666736  whole yes
[INFO] [stdout]                                score            -3  widest     +0  runs       +33432655  swept      +33469056
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::forensics::xchacha20::test_xor_decrypting_leaves_nothing' (1485) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/redoubt-forensics-core-0.1.0-rc.18/src/verdicts.rs:55:5:
[INFO] [stdout] the whole secret was left behind by xor, decrypting, of the plaintext: score        18234  widest  1024  runs       56407669  swept      56666736  whole yes
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x59861b170901 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]    1:     0x59861b18614a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    2:     0x59861b174f7c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]    3:     0x59861b14b8c6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]    4:     0x59861b168cc9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]    5:     0x59861b0ead70 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]    6:     0x59861b168e82 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]    7:     0x59861b14b972 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]    8:     0x59861b144539 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]    9:     0x59861b14c45d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]   10:     0x59861b1868ac - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]   11:     0x59861b1344e8 - redoubt_forensics_core[32e8484f8a33e1c3]::verdicts::leaves_nothing
[INFO] [stdout]   12:     0x59861b13328b - <redoubt_forensics_core[32e8484f8a33e1c3]::watching::Watching>::none_left
[INFO] [stdout]   13:     0x59861b0bfae1 - <redoubt_chacha[71c0fe0a4e6b5197]::tests::forensics::xchacha20::test_xor_decrypting_leaves_nothing::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]   14:     0x59861b0de1bb - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]   15:     0x59861b0eb395 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]   16:     0x59861b0e4c84 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]   17:     0x59861b0ee422 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]   18:     0x59861b17015f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]   19:     0x70549a48cdfa - <unknown>
[INFO] [stdout]   20:     0x70549a5203d4 - clone
[INFO] [stdout]   21:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout]     tests::forensics::chacha20::test_xor_bernstein_decrypting_leaves_nothing
[INFO] [stdout]     tests::forensics::chacha20::test_xor_bernstein_encrypting_leaves_nothing
[INFO] [stdout]     tests::forensics::chacha20::test_xor_decrypting_leaves_nothing
[INFO] [stdout]     tests::forensics::chacha20::test_xor_encrypting_leaves_nothing
[INFO] [stdout]     tests::forensics::hchacha20::test_subkey_leaves_nothing
[INFO] [stdout]     tests::forensics::xchacha20::test_xor_decrypting_leaves_nothing
[INFO] [stdout]     tests::forensics::xchacha20::test_xor_encrypting_leaves_nothing
[INFO] [stdout] 
[INFO] [stdout] test result: FAILED. 130 passed; 7 failed; 3 ignored; 0 measured; 0 filtered out; finished in 7.18s
[INFO] [stdout] 
[INFO] [stderr] error: test failed, to rerun pass `--lib`
[INFO] running `Command { std: "docker" "inspect" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2", kill_on_drop: false }`
[INFO] [stdout] 6dd4313af495a336979185390cc471d1d24eb62a8f12164534cc678fe69658e2
