[INFO] cloning repository https://github.com/randoguyname/bitstream-autocorrelation
[INFO] running `Command { std: "git" "-c" "credential.helper=" "-c" "credential.helper=/workspace/cargo-home/bin/git-credential-null" "clone" "--bare" "https://github.com/randoguyname/bitstream-autocorrelation" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Frandoguyname%2Fbitstream-autocorrelation", kill_on_drop: false }`
[INFO] [stderr] Cloning into bare repository '/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Frandoguyname%2Fbitstream-autocorrelation'...
[INFO] running `Command { std: "git" "rev-parse" "HEAD", kill_on_drop: false }`
[INFO] [stdout] d64867144507333f08ff0fe0970850b5c0197f7f
[INFO] testing randoguyname/bitstream-autocorrelation against master#ec6f9a5b4413f74386267ef8efc93712c2ce6db6 for pr-155739
[INFO] running `Command { std: "git" "clone" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Frandoguyname%2Fbitstream-autocorrelation" "/workspace/builds/worker-2-tc1/source", kill_on_drop: false }`
[INFO] [stderr] Cloning into '/workspace/builds/worker-2-tc1/source'...
[INFO] [stderr] done.
[INFO] started tweaking git repo https://github.com/randoguyname/bitstream-autocorrelation
[INFO] finished tweaking git repo https://github.com/randoguyname/bitstream-autocorrelation
[INFO] tweaked toml for git repo https://github.com/randoguyname/bitstream-autocorrelation written to /workspace/builds/worker-2-tc1/source/Cargo.toml
[INFO] validating manifest of git repo https://github.com/randoguyname/bitstream-autocorrelation on toolchain ec6f9a5b4413f74386267ef8efc93712c2ce6db6
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+ec6f9a5b4413f74386267ef8efc93712c2ce6db6" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate git repo https://github.com/randoguyname/bitstream-autocorrelation 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" "+ec6f9a5b4413f74386267ef8efc93712c2ce6db6" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] [stderr]     Updating crates.io index
[INFO] [stderr]  Downloading crates ...
[INFO] [stderr]   Downloaded csv-core v0.1.13
[INFO] [stderr]   Downloaded minimp3 v0.5.2
[INFO] [stderr]   Downloaded creak v0.3.0
[INFO] [stderr]   Downloaded mach2 v0.5.0
[INFO] [stderr]   Downloaded coreaudio-rs v0.13.0
[INFO] [stderr]   Downloaded hound v3.5.1
[INFO] [stderr]   Downloaded objc2-core-audio v0.3.2
[INFO] [stderr]   Downloaded slice-ring-buffer v0.3.4
[INFO] [stderr]   Downloaded toml_parser v1.0.8+spec-1.1.0
[INFO] [stderr]   Downloaded claxon v0.4.3
[INFO] [stderr]   Downloaded objc2-core-audio-types v0.3.2
[INFO] [stderr]   Downloaded alsa v0.10.0
[INFO] [stderr]   Downloaded minimp3-sys v0.3.2
[INFO] [stderr]   Downloaded objc2-avf-audio v0.3.2
[INFO] [stderr]   Downloaded cpal v0.17.1
[INFO] [stderr]   Downloaded objc2-audio-toolbox v0.3.2
[INFO] [stderr]   Downloaded syn v2.0.116
[INFO] [stderr]   Downloaded csv v1.4.0
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+ec6f9a5b4413f74386267ef8efc93712c2ce6db6" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] 57ac90815bb1bf6bfbbb0826f906faa3c53575c05171a605511ba9335779dc5a
[INFO] running `Command { std: "docker" "start" "-a" "57ac90815bb1bf6bfbbb0826f906faa3c53575c05171a605511ba9335779dc5a", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "57ac90815bb1bf6bfbbb0826f906faa3c53575c05171a605511ba9335779dc5a", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "57ac90815bb1bf6bfbbb0826f906faa3c53575c05171a605511ba9335779dc5a", kill_on_drop: false }`
[INFO] [stdout] 57ac90815bb1bf6bfbbb0826f906faa3c53575c05171a605511ba9335779dc5a
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/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" "RUSTDOCFLAGS=--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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+ec6f9a5b4413f74386267ef8efc93712c2ce6db6" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] c43d14c9810a4f36b32151a376d7cf0aa1dca58eee3f805e7e3cc457f3d7459b
[INFO] running `Command { std: "docker" "start" "-a" "c43d14c9810a4f36b32151a376d7cf0aa1dca58eee3f805e7e3cc457f3d7459b", kill_on_drop: false }`
[INFO] [stderr]    Compiling once_cell v1.21.3
[INFO] [stderr]    Compiling serde_core v1.0.228
[INFO] [stderr]    Compiling log v0.4.29
[INFO] [stderr]    Compiling memchr v2.8.0
[INFO] [stderr]    Compiling pin-project-lite v0.2.16
[INFO] [stderr]    Compiling nu-ansi-term v0.50.3
[INFO] [stderr]    Compiling itoa v1.0.17
[INFO] [stderr]    Compiling thread_local v1.1.9
[INFO] [stderr]    Compiling sharded-slab v0.1.7
[INFO] [stderr]    Compiling quote v1.0.44
[INFO] [stderr]    Compiling chrono v0.4.43
[INFO] [stderr]    Compiling tracing-core v0.1.36
[INFO] [stderr]    Compiling syn v2.0.116
[INFO] [stderr]    Compiling csv-core v0.1.13
[INFO] [stderr]    Compiling tracing-log v0.2.0
[INFO] [stderr]    Compiling tracing-subscriber v0.3.22
[INFO] [stderr]    Compiling csv v1.4.0
[INFO] [stderr]    Compiling tracing-attributes v0.1.31
[INFO] [stderr]    Compiling tracing v0.1.44
[INFO] [stderr]    Compiling bitstream-autocorrelation v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `dev` profile [unoptimized + debuginfo] target(s) in 12.12s
[INFO] running `Command { std: "docker" "inspect" "c43d14c9810a4f36b32151a376d7cf0aa1dca58eee3f805e7e3cc457f3d7459b", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "c43d14c9810a4f36b32151a376d7cf0aa1dca58eee3f805e7e3cc457f3d7459b", kill_on_drop: false }`
[INFO] [stdout] c43d14c9810a4f36b32151a376d7cf0aa1dca58eee3f805e7e3cc457f3d7459b
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/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" "RUSTDOCFLAGS=--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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+ec6f9a5b4413f74386267ef8efc93712c2ce6db6" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] da1c966189123cb393f7c110224963ddc04cd67c524f6e3e4d199d928cd1cbb4
[INFO] running `Command { std: "docker" "start" "-a" "da1c966189123cb393f7c110224963ddc04cd67c524f6e3e4d199d928cd1cbb4", kill_on_drop: false }`
[INFO] [stderr]    Compiling libc v0.2.182
[INFO] [stderr]    Compiling find-msvc-tools v0.1.9
[INFO] [stderr]    Compiling pkg-config v0.3.32
[INFO] [stderr]    Compiling ogg v0.8.0
[INFO] [stderr]    Compiling tinyvec v1.10.0
[INFO] [stderr]    Compiling bitflags v2.11.0
[INFO] [stderr]    Compiling cpal v0.17.1
[INFO] [stderr]    Compiling hound v3.5.1
[INFO] [stderr]    Compiling bytes v1.11.1
[INFO] [stderr]    Compiling dasp_sample v0.11.0
[INFO] [stderr]    Compiling claxon v0.4.3
[INFO] [stderr]    Compiling syn v2.0.116
[INFO] [stderr]    Compiling cc v1.2.56
[INFO] [stderr]    Compiling alsa-sys v0.3.1
[INFO] [stderr]    Compiling lewton v0.10.2
[INFO] [stderr]    Compiling parking_lot_core v0.9.12
[INFO] [stderr]    Compiling slice-ring-buffer v0.3.4
[INFO] [stderr]    Compiling errno v0.3.14
[INFO] [stderr]    Compiling mio v1.1.1
[INFO] [stderr]    Compiling socket2 v0.6.2
[INFO] [stderr]    Compiling signal-hook-registry v1.4.8
[INFO] [stderr]    Compiling minimp3-sys v0.3.2
[INFO] [stderr]    Compiling parking_lot v0.12.5
[INFO] [stderr]    Compiling alsa v0.10.0
[INFO] [stderr]    Compiling thiserror-impl v1.0.69
[INFO] [stderr]    Compiling tracing-attributes v0.1.31
[INFO] [stderr]    Compiling tokio-macros v2.6.0
[INFO] [stderr]    Compiling tokio v1.49.0
[INFO] [stderr]    Compiling thiserror v1.0.69
[INFO] [stderr]    Compiling minimp3 v0.5.2
[INFO] [stderr]    Compiling creak v0.3.0
[INFO] [stderr]    Compiling tracing v0.1.44
[INFO] [stderr]    Compiling bitstream-autocorrelation v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 23.17s
[INFO] running `Command { std: "docker" "inspect" "da1c966189123cb393f7c110224963ddc04cd67c524f6e3e4d199d928cd1cbb4", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "da1c966189123cb393f7c110224963ddc04cd67c524f6e3e4d199d928cd1cbb4", kill_on_drop: false }`
[INFO] [stdout] da1c966189123cb393f7c110224963ddc04cd67c524f6e3e4d199d928cd1cbb4
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2-tc1/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" "RUSTDOCFLAGS=--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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+ec6f9a5b4413f74386267ef8efc93712c2ce6db6" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] 1974bced333daa13c1ff5754f83e9257df51025dce3be8594b631729a9f90630
[INFO] running `Command { std: "docker" "start" "-a" "1974bced333daa13c1ff5754f83e9257df51025dce3be8594b631729a9f90630", kill_on_drop: false }`
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 0.19s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/bitstream_autocorrelation-e266d6a88b2aed57)
[INFO] [stdout] 
[INFO] [stdout] running 3 tests
[INFO] [stdout] [2m2026-05-11T20:58:24.935252Z[0m [32m INFO[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m test-files/test-246-guitar.mp3 has sample rate 44100
[INFO] [stdout] [2m2026-05-11T20:58:24.937530Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.938621Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 538 is a subharmonic of 80 (0.6435547 vs 0.64160156)
[INFO] [stdout] [2m2026-05-11T20:58:24.939640Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 76.89746 at 44100hZ = 573.49097hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.944475Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:24.944577Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.945801Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 93 with 182 (0.0703125 vs 0.9453125)
[INFO] [stdout] [2m2026-05-11T20:58:24.945882Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 182 with 355 (0.9453125 vs 0.9921875)
[INFO] [stdout] [2m2026-05-11T20:58:24.946921Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 355.13217 at 44100hZ = 124.179115hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.949479Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:24.949729Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 124.179115
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.950272Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 85 with 176 (0.05078125 vs 0.9667969)
[INFO] [stdout] [2m2026-05-11T20:58:24.953478Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 176 with 357 (0.9667969 vs 0.99121094)
[INFO] [stdout] [2m2026-05-11T20:58:24.953711Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 715 is a subharmonic of 357 (0.99316406 vs 0.99121094)
[INFO] [stdout] [2m2026-05-11T20:58:24.954385Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 357.63272 at 44100hZ = 123.31087hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.957330Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 1
[INFO] [stdout] [2m2026-05-11T20:58:24.957551Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 123.31087
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.958678Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 358 is a subharmonic of 178 (0.98828125 vs 0.9824219)
[INFO] [stdout] [2m2026-05-11T20:58:24.959330Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 714 is a subharmonic of 178 (0.9892578 vs 0.98828125)
[INFO] [stdout] [2m2026-05-11T20:58:24.960013Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 357 is a subharmonic of 178 (0.9902344 vs 0.9892578)
[INFO] [stderr] ALSA lib confmisc.c:855:(parse_card) cannot find card '0'
[INFO] [stderr] ALSA lib conf.c:5204:(_snd_config_evaluate) function snd_func_card_inum returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:422:(snd_func_concat) error evaluating strings
[INFO] [stderr] ALSA lib conf.c:5204:(_snd_config_evaluate) function snd_func_concat returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:1342:(snd_func_refer) error evaluating name
[INFO] [stderr] ALSA lib conf.c:5204:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
[INFO] [stderr] ALSA lib conf.c:5727:(snd_config_expand) Evaluate error: No such file or directory
[INFO] [stderr] ALSA lib pcm.c:2721:(snd_pcm_open_noupdate) Unknown PCM default
[INFO] [stdout] [2m2026-05-11T20:58:24.964054Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.57811 at 44100hZ = 246.95076hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.964091Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (2)
[INFO] [stdout] [2m2026-05-11T20:58:24.964121Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.9902344
[INFO] [stdout] [2m2026-05-11T20:58:24.964135Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [124.179115, 123.31087, 246.95076]
[INFO] [stdout] [2m2026-05-11T20:58:24.964150Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 2
[INFO] [stdout] [2m2026-05-11T20:58:24.964179Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 124.179115
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.964581Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 221 is a subharmonic of 43 (0.50390625 vs 0.49609375)
[INFO] [stdout] [2m2026-05-11T20:58:24.964614Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 577 is a subharmonic of 43 (0.52441406 vs 0.50390625)
[INFO] [stdout] [2m2026-05-11T20:58:24.964631Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 934 is a subharmonic of 43 (0.53808594 vs 0.52441406)
[INFO] [stdout] [2m2026-05-11T20:58:24.964657Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 43 with 178 (0.53808594 vs 0.9892578)
[INFO] [stdout] [2m2026-05-11T20:58:24.964673Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 357 is a subharmonic of 178 (0.99316406 vs 0.9892578)
[INFO] [stdout] [2m2026-05-11T20:58:24.965240Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.53876 at 44100hZ = 247.00519hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.965267Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (3)
[INFO] [stdout] [2m2026-05-11T20:58:24.965280Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.99316406
[INFO] [stdout] [2m2026-05-11T20:58:24.965291Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [247.00519, 123.31087, 246.95076]
[INFO] [stdout] [2m2026-05-11T20:58:24.965317Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 3
[INFO] [stdout] [2m2026-05-11T20:58:24.965329Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.95076
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.967746Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 51 with 138 (0.40722656 vs 0.5644531)
[INFO] [stdout] [2m2026-05-11T20:58:24.967788Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 357 is a subharmonic of 179 (0.99121094 vs 0.98535156)
[INFO] [stdout] [2m2026-05-11T20:58:24.968343Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.62439 at 44100hZ = 246.88678hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.968373Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [247.00519, 246.88678, 246.95076]
[INFO] [stdout] [2m2026-05-11T20:58:24.968387Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 4
[INFO] [stdout] [2m2026-05-11T20:58:24.968398Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.95076
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.980084Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 52 with 150 (0.4140625 vs 0.6845703)
[INFO] [stdout] [2m2026-05-11T20:58:24.980148Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 358 is a subharmonic of 181 (0.9873047 vs 0.98046875)
[INFO] [stdout] [2m2026-05-11T20:58:24.981296Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.00691 at 44100hZ = 246.3592hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.981333Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [247.00519, 246.88678, 246.3592]
[INFO] [stdout] [2m2026-05-11T20:58:24.981350Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 5
[INFO] [stdout] [2m2026-05-11T20:58:24.984492Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.88678
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.985772Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 70 with 149 (0.19726563 vs 0.6816406)
[INFO] [stdout] [2m2026-05-11T20:58:24.987076Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.07858 at 44100hZ = 246.2606hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.987114Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.2606, 246.88678, 246.3592]
[INFO] [stdout] [2m2026-05-11T20:58:24.987131Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 6
[INFO] [stdout] [2m2026-05-11T20:58:24.992504Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.3592
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.993174Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 351 is a subharmonic of 171 (0.9394531 vs 0.92285156)
[INFO] [stdout] [2m2026-05-11T20:58:24.993212Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 171 with 179 (0.9394531 vs 0.9873047)
[INFO] [stdout] [2m2026-05-11T20:58:24.993827Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.34215 at 44100hZ = 247.2775hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.993858Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.2606, 247.2775, 246.3592]
[INFO] [stdout] [2m2026-05-11T20:58:24.993873Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 7
[INFO] [stdout] [2m2026-05-11T20:58:24.993909Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.3592
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.994363Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 92 with 343 (0.13378906 vs 0.84472656)
[INFO] [stdout] [2m2026-05-11T20:58:24.994409Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 174 with 357 (0.95214844 vs 0.98339844)
[INFO] [stdout] [2m2026-05-11T20:58:24.994885Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 177.46011 at 44100hZ = 248.50655hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.994913Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.2606, 247.2775, 248.50655]
[INFO] [stdout] [2m2026-05-11T20:58:24.994926Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 8
[INFO] [stdout] [2m2026-05-11T20:58:24.994938Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 247.2775
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:24.995432Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 357 is a subharmonic of 176 (0.9794922 vs 0.9609375)
[INFO] [stdout] [2m2026-05-11T20:58:24.995479Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 716 is a subharmonic of 176 (0.984375 vs 0.9794922)
[INFO] [stdout] [2m2026-05-11T20:58:24.995520Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 179 is a subharmonic of 176 (0.9863281 vs 0.984375)
[INFO] [stdout] [2m2026-05-11T20:58:24.995543Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 359 is a subharmonic of 176 (0.99121094 vs 0.9863281)
[INFO] [stdout] [2m2026-05-11T20:58:24.997829Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.48502 at 44100hZ = 245.70296hZ
[INFO] [stdout] [2m2026-05-11T20:58:24.997861Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.70296, 247.2775, 248.50655]
[INFO] [stdout] [2m2026-05-11T20:58:24.997874Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 9
[INFO] [stdout] [2m2026-05-11T20:58:24.997884Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 247.2775
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.000245Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.40694 at 44100hZ = 245.80989hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.007478Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.70296, 245.80989, 248.50655]
[INFO] [stdout] [2m2026-05-11T20:58:25.007510Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 10
[INFO] [stdout] [2m2026-05-11T20:58:25.007522Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.80989
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.007789Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 84 with 181 (0.12402344 vs 0.9404297)
[INFO] [stdout] [2m2026-05-11T20:58:25.008384Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.7008 at 44100hZ = 246.7812hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.008402Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.70296, 245.80989, 246.7812]
[INFO] [stdout] [2m2026-05-11T20:58:25.008415Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 11
[INFO] [stdout] [2m2026-05-11T20:58:25.008425Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.80989
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.008827Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 100 with 209 (0.2763672 vs 0.6455078)
[INFO] [stdout] [2m2026-05-11T20:58:25.009158Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.88342 at 44100hZ = 246.52927hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.009171Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.52927, 245.80989, 246.7812]
[INFO] [stdout] [2m2026-05-11T20:58:25.009182Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 12
[INFO] [stdout] [2m2026-05-11T20:58:25.009192Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.52927
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.009676Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 538 is a subharmonic of 178 (0.9824219 vs 0.9824219)
[INFO] [stdout] [2m2026-05-11T20:58:25.009741Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 179 is a subharmonic of 178 (0.98339844 vs 0.9824219)
[INFO] [stdout] [2m2026-05-11T20:58:25.011524Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 180.69453 at 44100hZ = 244.05829hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.011606Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.52927, 244.05829, 246.7812]
[INFO] [stdout] [2m2026-05-11T20:58:25.011648Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 13
[INFO] [stdout] [2m2026-05-11T20:58:25.011731Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.52927
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.012178Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 716 is a subharmonic of 179 (0.98046875 vs 0.98046875)
[INFO] [stdout] [2m2026-05-11T20:58:25.013742Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.33658 at 44100hZ = 245.90633hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.013812Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.52927, 244.05829, 245.90633]
[INFO] [stdout] [2m2026-05-11T20:58:25.013860Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 14
[INFO] [stdout] [2m2026-05-11T20:58:25.013936Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.90633
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.014252Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 536 is a subharmonic of 179 (0.99316406 vs 0.99121094)
[INFO] [stdout] [2m2026-05-11T20:58:25.015736Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.20088 at 44100hZ = 246.09254hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.015803Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.09254, 244.05829, 245.90633]
[INFO] [stdout] [2m2026-05-11T20:58:25.015858Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 15
[INFO] [stdout] [2m2026-05-11T20:58:25.015932Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.90633
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.018437Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.21141 at 44100hZ = 246.07808hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.020473Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.09254, 246.07808, 245.90633]
[INFO] [stdout] [2m2026-05-11T20:58:25.020549Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 16
[INFO] [stdout] [2m2026-05-11T20:58:25.020586Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.07808
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.021033Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 58 with 183 (0.39160156 vs 0.8769531)
[INFO] [stdout] [2m2026-05-11T20:58:25.021111Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 183 with 895 (0.8769531 vs 0.93847656)
[INFO] [stdout] [2m2026-05-11T20:58:25.021727Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 895.3624 at 44100hZ = 49.2538hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.023484Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.023558Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.09254, 246.07808, 246.269]
[INFO] [stdout] [2m2026-05-11T20:58:25.023594Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 17
[INFO] [stdout] [2m2026-05-11T20:58:25.023647Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.09254
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.024093Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 359 is a subharmonic of 177 (0.9404297 vs 0.9355469)
[INFO] [stdout] [2m2026-05-11T20:58:25.024174Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 181 is a subharmonic of 177 (0.94921875 vs 0.9404297)
[INFO] [stdout] [2m2026-05-11T20:58:25.026762Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.625 at 44100hZ = 245.51149hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.026849Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.51149, 246.07808, 246.269]
[INFO] [stdout] [2m2026-05-11T20:58:25.026891Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 18
[INFO] [stdout] [2m2026-05-11T20:58:25.026969Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.07808
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.027394Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 53 with 177 (0.34375 vs 0.921875)
[INFO] [stdout] [2m2026-05-11T20:58:25.029491Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 360 is a subharmonic of 177 (0.9277344 vs 0.921875)
[INFO] [stdout] [2m2026-05-11T20:58:25.029573Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 897 is a subharmonic of 177 (0.9345703 vs 0.9277344)
[INFO] [stdout] [2m2026-05-11T20:58:25.029616Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 179 is a subharmonic of 177 (0.94140625 vs 0.9345703)
[INFO] [stdout] [2m2026-05-11T20:58:25.030256Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.15118 at 44100hZ = 246.16081hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.031469Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.51149, 246.16081, 246.269]
[INFO] [stdout] [2m2026-05-11T20:58:25.031544Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 19
[INFO] [stdout] [2m2026-05-11T20:58:25.031585Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.16081
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.031960Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 362 is a subharmonic of 183 (0.9189453 vs 0.9160156)
[INFO] [stdout] [2m2026-05-11T20:58:25.034475Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 183 with 537 (0.9189453 vs 0.9501953)
[INFO] [stdout] [2m2026-05-11T20:58:25.035947Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.81647 at 44100hZ = 246.62158hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.036030Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.51149, 246.16081, 246.62158]
[INFO] [stdout] [2m2026-05-11T20:58:25.036071Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 20
[INFO] [stdout] [2m2026-05-11T20:58:25.036148Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.16081
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.036599Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 46 with 175 (0.29882813 vs 0.8466797)
[INFO] [stdout] [2m2026-05-11T20:58:25.036669Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 175 with 358 (0.8466797 vs 0.92285156)
[INFO] [stdout] [2m2026-05-11T20:58:25.036711Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 716 is a subharmonic of 358 (0.9375 vs 0.92285156)
[INFO] [stdout] [2m2026-05-11T20:58:25.037480Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 358.0625 at 44100hZ = 123.16286hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.039474Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.039555Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.32571, 246.16081, 246.62158]
[INFO] [stdout] [2m2026-05-11T20:58:25.039598Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 21
[INFO] [stdout] [2m2026-05-11T20:58:25.041493Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.32571
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.041966Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 46 with 171 (0.27539063 vs 0.8095703)
[INFO] [stdout] [2m2026-05-11T20:58:25.042031Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 171 with 353 (0.8095703 vs 0.84375)
[INFO] [stdout] [2m2026-05-11T20:58:25.042069Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 353 with 717 (0.84375 vs 0.92089844)
[INFO] [stdout] [2m2026-05-11T20:58:25.042735Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 359.67178 at 44100hZ = 122.611786hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.049480Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.049568Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.32571, 245.22357, 246.62158]
[INFO] [stdout] [2m2026-05-11T20:58:25.049612Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 22
[INFO] [stdout] [2m2026-05-11T20:58:25.049787Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.32571
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.050265Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 100 with 636 (0.5751953 vs 0.6044922)
[INFO] [stdout] [2m2026-05-11T20:58:25.050425Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 715 is a subharmonic of 182 (0.93359375 vs 0.9326172)
[INFO] [stdout] [2m2026-05-11T20:58:25.050510Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 897 is a subharmonic of 182 (0.9511719 vs 0.93359375)
[INFO] [stdout] [2m2026-05-11T20:58:25.051181Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.24347 at 44100hZ = 246.03407hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.051256Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.32571, 245.22357, 246.03407]
[INFO] [stdout] [2m2026-05-11T20:58:25.051297Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 23
[INFO] [stdout] [2m2026-05-11T20:58:25.051375Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.03407
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.051688Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 44 with 179 (0.19238281 vs 0.95214844)
[INFO] [stdout] [2m2026-05-11T20:58:25.052348Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.3195 at 44100hZ = 245.92975hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.052410Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.92975, 245.22357, 246.03407]
[INFO] [stdout] [2m2026-05-11T20:58:25.052475Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 24
[INFO] [stdout] [2m2026-05-11T20:58:25.052525Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.92975
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.053011Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 897 is a subharmonic of 178 (0.94140625 vs 0.93847656)
[INFO] [stdout] [2m2026-05-11T20:58:25.053085Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 179 is a subharmonic of 178 (0.94140625 vs 0.94140625)
[INFO] [stdout] [2m2026-05-11T20:58:25.054926Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.0091 at 44100hZ = 246.3562hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.054998Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.92975, 246.3562, 246.03407]
[INFO] [stdout] [2m2026-05-11T20:58:25.055040Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 25
[INFO] [stdout] [2m2026-05-11T20:58:25.055128Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.03407
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.055602Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 45 with 141 (0.17578125 vs 0.20507813)
[INFO] [stdout] [2m2026-05-11T20:58:25.055676Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 141 with 278 (0.20507813 vs 0.7314453)
[INFO] [stdout] [2m2026-05-11T20:58:25.055722Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 714 is a subharmonic of 357 (0.9453125 vs 0.94140625)
[INFO] [stdout] [2m2026-05-11T20:58:25.056414Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 357.0802 at 44100hZ = 123.50167hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.058469Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.058535Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.92975, 246.3562, 247.00334]
[INFO] [stdout] [2m2026-05-11T20:58:25.058614Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 26
[INFO] [stdout] [2m2026-05-11T20:58:25.058675Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.3562
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.059128Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 32 with 210 (0.29296875 vs 0.33398438)
[INFO] [stdout] [2m2026-05-11T20:58:25.059200Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 705 is a subharmonic of 346 (0.7246094 vs 0.70703125)
[INFO] [stdout] [2m2026-05-11T20:58:25.059247Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 719 is a subharmonic of 178 (0.9267578 vs 0.9238281)
[INFO] [stdout] [2m2026-05-11T20:58:25.059329Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 180 is a subharmonic of 178 (0.9355469 vs 0.9267578)
[INFO] [stdout] [2m2026-05-11T20:58:25.061024Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 180.71922 at 44100hZ = 244.02495hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.061101Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.02495, 246.3562, 247.00334]
[INFO] [stdout] [2m2026-05-11T20:58:25.061148Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 27
[INFO] [stdout] [2m2026-05-11T20:58:25.061226Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.3562
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.061676Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 39 with 82 (0.19921875 vs 0.7421875)
[INFO] [stdout] [2m2026-05-11T20:58:25.062470Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 268 is a subharmonic of 82 (0.75683594 vs 0.7421875)
[INFO] [stdout] [2m2026-05-11T20:58:25.062541Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 620 is a subharmonic of 82 (0.7685547 vs 0.75683594)
[INFO] [stdout] [2m2026-05-11T20:58:25.063467Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 801 is a subharmonic of 82 (0.79003906 vs 0.7685547)
[INFO] [stdout] [2m2026-05-11T20:58:25.063536Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 82 with 894 (0.79003906 vs 0.9082031)
[INFO] [stdout] [2m2026-05-11T20:58:25.064321Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 359.01334 at 44100hZ = 122.83666hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.065498Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.065682Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.02495, 245.67332, 247.00334]
[INFO] [stdout] [2m2026-05-11T20:58:25.065762Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 28
[INFO] [stdout] [2m2026-05-11T20:58:25.065837Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.67332
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.066148Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 48 with 145 (0.14550781 vs 0.23339844)
[INFO] [stdout] [2m2026-05-11T20:58:25.066306Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 361 is a subharmonic of 183 (0.92578125 vs 0.91503906)
[INFO] [stdout] [2m2026-05-11T20:58:25.066483Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 539 is a subharmonic of 183 (0.9433594 vs 0.92578125)
[INFO] [stdout] [2m2026-05-11T20:58:25.066617Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 717 is a subharmonic of 183 (0.9482422 vs 0.9433594)
[INFO] [stdout] [2m2026-05-11T20:58:25.068170Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.93088 at 44100hZ = 246.46388hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.069474Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.02495, 245.67332, 246.46388]
[INFO] [stdout] [2m2026-05-11T20:58:25.069554Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 29
[INFO] [stdout] [2m2026-05-11T20:58:25.069593Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.67332
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.072964Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 896.38196 at 44100hZ = 49.197777hZ
[INFO] [stdout] test tests::test_from_files ... FAILED
[INFO] [stdout] [2m2026-05-11T20:58:25.073991Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.074093Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.98889, 245.67332, 246.46388]
[INFO] [stdout] [2m2026-05-11T20:58:25.074108Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 30
[INFO] [stdout] [2m2026-05-11T20:58:25.074119Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.98889
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.074544Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 42 with 91 (0.125 vs 0.85546875)
[INFO] [stdout] [2m2026-05-11T20:58:25.074560Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 91 with 179 (0.85546875 vs 0.9316406)
[INFO] [stdout] [2m2026-05-11T20:58:25.074581Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 898 is a subharmonic of 179 (0.9394531 vs 0.9316406)
[INFO] [stdout] [2m2026-05-11T20:58:25.075438Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.85263 at 44100hZ = 245.20074hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.075466Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.98889, 245.20074, 246.46388]
[INFO] [stdout] [2m2026-05-11T20:58:25.075478Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 31
[INFO] [stdout] [2m2026-05-11T20:58:25.075489Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.98889
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.075894Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 717 is a subharmonic of 182 (0.93847656 vs 0.9199219)
[INFO] [stdout] [2m2026-05-11T20:58:25.075944Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 359 is a subharmonic of 182 (0.93847656 vs 0.93847656)
[INFO] [stdout] [2m2026-05-11T20:58:25.075961Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 716 is a subharmonic of 182 (0.9394531 vs 0.93847656)
[INFO] [stdout] [2m2026-05-11T20:58:25.076045Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 358 is a subharmonic of 182 (0.94140625 vs 0.9394531)
[INFO] [stdout] [2m2026-05-11T20:58:25.076762Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.6923 at 44100hZ = 245.41953hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.076780Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [245.98889, 245.20074, 245.41953]
[INFO] [stdout] [2m2026-05-11T20:58:25.076792Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 32
[INFO] [stdout] [2m2026-05-11T20:58:25.076803Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.41953
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.077073Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 98 with 183 (0.81152344 vs 0.89941406)
[INFO] [stdout] [2m2026-05-11T20:58:25.077089Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 183 with 716 (0.89941406 vs 0.92285156)
[INFO] [stdout] [2m2026-05-11T20:58:25.077695Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 895.5994 at 44100hZ = 49.240765hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.077813Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.077967Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.20383, 245.20074, 245.41953]
[INFO] [stdout] [2m2026-05-11T20:58:25.078191Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 33
[INFO] [stdout] [2m2026-05-11T20:58:25.078252Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.41953
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.079169Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 537 is a subharmonic of 181 (0.9199219 vs 0.9160156)
[INFO] [stdout] [2m2026-05-11T20:58:25.079379Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 895 is a subharmonic of 181 (0.921875 vs 0.9199219)
[INFO] [stdout] [2m2026-05-11T20:58:25.080928Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.46667 at 44100hZ = 245.72807hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.081097Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.20383, 245.72807, 245.41953]
[INFO] [stdout] [2m2026-05-11T20:58:25.081252Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 34
[INFO] [stdout] [2m2026-05-11T20:58:25.081318Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.72807
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.081917Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 46 with 184 (0.1875 vs 0.8095703)
[INFO] [stdout] [2m2026-05-11T20:58:25.082033Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 536 is a subharmonic of 184 (0.81152344 vs 0.8095703)
[INFO] [stdout] [2m2026-05-11T20:58:25.082121Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 723 is a subharmonic of 179 (0.8408203 vs 0.83984375)
[INFO] [stdout] [2m2026-05-11T20:58:25.082206Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 898 is a subharmonic of 179 (0.8457031 vs 0.8408203)
[INFO] [stdout] [2m2026-05-11T20:58:25.082363Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 713 is a subharmonic of 179 (0.86621094 vs 0.8457031)
[INFO] [stdout] [2m2026-05-11T20:58:25.083287Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.55682 at 44100hZ = 246.9802hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.083372Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.20383, 245.72807, 246.9802]
[INFO] [stdout] [2m2026-05-11T20:58:25.083415Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 35
[INFO] [stdout] [2m2026-05-11T20:58:25.083513Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.20383
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.084129Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 40 with 92 (0.19433594 vs 0.8388672)
[INFO] [stdout] [2m2026-05-11T20:58:25.084213Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 173 is a subharmonic of 92 (0.85253906 vs 0.8388672)
[INFO] [stdout] [2m2026-05-11T20:58:25.084260Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 92 with 537 (0.85253906 vs 0.88964844)
[INFO] [stdout] test tests::test_with_microphone ... FAILED
[INFO] [stdout] [2m2026-05-11T20:58:25.084498Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 897 is a subharmonic of 179 (0.91796875 vs 0.9169922)
[INFO] [stdout] [2m2026-05-11T20:58:25.085380Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 178.69363 at 44100hZ = 246.7911hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.085481Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.7911, 245.72807, 246.9802]
[INFO] [stdout] [2m2026-05-11T20:58:25.085523Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 36
[INFO] [stdout] [2m2026-05-11T20:58:25.085774Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.7911
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.086684Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 98 with 182 (0.7910156 vs 0.890625)
[INFO] [stdout] [2m2026-05-11T20:58:25.086769Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 541 is a subharmonic of 182 (0.89746094 vs 0.890625)
[INFO] [stdout] [2m2026-05-11T20:58:25.086853Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 894 is a subharmonic of 177 (0.9033203 vs 0.9033203)
[INFO] [stdout] [2m2026-05-11T20:58:25.087072Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 356 is a subharmonic of 177 (0.9169922 vs 0.9033203)
[INFO] [stdout] [2m2026-05-11T20:58:25.087117Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 897 is a subharmonic of 177 (0.9277344 vs 0.9169922)
[INFO] [stdout] [2m2026-05-11T20:58:25.087964Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.63394 at 44100hZ = 245.49927hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.088039Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.7911, 245.49927, 246.9802]
[INFO] [stdout] [2m2026-05-11T20:58:25.088079Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 37
[INFO] [stdout] [2m2026-05-11T20:58:25.088161Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.7911
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.088485Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 47 with 126 (0.14648438 vs 0.20898438)
[INFO] [stdout] [2m2026-05-11T20:58:25.088673Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 720 is a subharmonic of 182 (0.8847656 vs 0.8808594)
[INFO] [stdout] [2m2026-05-11T20:58:25.088917Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 357 is a subharmonic of 182 (0.89453125 vs 0.8847656)
[INFO] [stdout] [2m2026-05-11T20:58:25.088982Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 717 is a subharmonic of 182 (0.89941406 vs 0.89453125)
[INFO] [stdout] [2m2026-05-11T20:58:25.089709Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 179.28572 at 44100hZ = 245.97609hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.089890Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [246.7911, 245.49927, 245.97609]
[INFO] [stdout] [2m2026-05-11T20:58:25.090081Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 38
[INFO] [stdout] [2m2026-05-11T20:58:25.090140Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.97609
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.090943Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 354 is a subharmonic of 180 (0.86035156 vs 0.85546875)
[INFO] [stdout] [2m2026-05-11T20:58:25.091369Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 539 is a subharmonic of 180 (0.86816406 vs 0.86035156)
[INFO] [stdout] [2m2026-05-11T20:58:25.091427Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 902 is a subharmonic of 180 (0.8769531 vs 0.86816406)
[INFO] [stdout] [2m2026-05-11T20:58:25.094472Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 180 with 359 (0.8769531 vs 0.90722656)
[INFO] [stdout] [2m2026-05-11T20:58:25.095139Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 360.53333 at 44100hZ = 122.31879hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.095208Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.095254Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.63757, 245.49927, 245.97609]
[INFO] [stdout] [2m2026-05-11T20:58:25.095325Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 39
[INFO] [stdout] [2m2026-05-11T20:58:25.095361Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.49927
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.095873Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 187 with 365 (0.8144531 vs 0.8544922)
[INFO] [stdout] [2m2026-05-11T20:58:25.095949Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 178 with 359 (0.88964844 vs 0.91308594)
[INFO] [stdout] [2m2026-05-11T20:58:25.096848Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 895.1538 at 44100hZ = 49.265278hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.096915Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.096947Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.63757, 246.32639, 245.97609]
[INFO] [stdout] [2m2026-05-11T20:58:25.096997Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 40
[INFO] [stdout] [2m2026-05-11T20:58:25.097048Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.97609
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.097494Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 705 is a subharmonic of 76 (0.70410156 vs 0.6953125)
[INFO] [stdout] [2m2026-05-11T20:58:25.097558Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 76 with 445 (0.70410156 vs 0.8496094)
[INFO] [stdout] [2m2026-05-11T20:58:25.098877Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 717.7778 at 44100hZ = 61.43963hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.099122Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.099229Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.63757, 246.32639, 245.75851]
[INFO] [stdout] [2m2026-05-11T20:58:25.099328Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 41
[INFO] [stdout] [2m2026-05-11T20:58:25.099363Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.75851
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.100178Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 262 is a subharmonic of 81 (0.8105469 vs 0.8046875)
[INFO] [stdout] [2m2026-05-11T20:58:25.100262Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 718 is a subharmonic of 81 (0.8300781 vs 0.8105469)
[INFO] [stdout] [2m2026-05-11T20:58:25.100309Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 358 is a subharmonic of 181 (0.8925781 vs 0.88671875)
[INFO] [stdout] [2m2026-05-11T20:58:25.101137Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 180.30833 at 44100hZ = 244.58104hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.101220Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.58104, 246.32639, 245.75851]
[INFO] [stdout] [2m2026-05-11T20:58:25.101261Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 42
[INFO] [stdout] [2m2026-05-11T20:58:25.101417Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.75851
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.101980Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 52 with 354 (0.25683594 vs 0.8232422)
[INFO] [stdout] [2m2026-05-11T20:58:25.102748Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 356.06668 at 44100hZ = 123.8532hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.102828Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.102868Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.58104, 247.7064, 245.75851]
[INFO] [stdout] [2m2026-05-11T20:58:25.102947Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 43
[INFO] [stdout] [2m2026-05-11T20:58:25.102985Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.75851
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.103514Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 173 with 895 (0.81152344 vs 0.85546875)
[INFO] [stdout] [2m2026-05-11T20:58:25.104189Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 893.1944 at 44100hZ = 49.373352hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.104256Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.104295Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [244.58104, 247.7064, 246.86676]
[INFO] [stdout] [2m2026-05-11T20:58:25.104358Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 44
[INFO] [stdout] [2m2026-05-11T20:58:25.104394Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.86676
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.105033Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 91 with 538 (0.7529297 vs 0.8222656)
[INFO] [stdout] [2m2026-05-11T20:58:25.105749Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 544.89087 at 44100hZ = 80.93364hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.105829Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.105867Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [242.80092, 247.7064, 246.86676]
[INFO] [stdout] [2m2026-05-11T20:58:25.105947Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 45
[INFO] [stdout] [2m2026-05-11T20:58:25.105985Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 246.86676
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.106630Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 91 with 898 (0.7861328 vs 0.8574219)
[INFO] [stdout] [2m2026-05-11T20:58:25.107329Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 896.50793 at 44100hZ = 49.190865hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.107387Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Checking for harmonics & subharmonics
[INFO] [stdout] [2m2026-05-11T20:58:25.107415Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [242.80092, 245.95432, 246.86676]
[INFO] [stdout] [2m2026-05-11T20:58:25.107470Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 46
[INFO] [stdout] [2m2026-05-11T20:58:25.107514Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.95432
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.108693Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 81.94286 at 44100hZ = 538.1799hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.108863Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.108925Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.109528Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 136 with 539 (0.4560547 vs 0.57128906)
[INFO] [stdout] [2m2026-05-11T20:58:25.109695Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 97 with 719 (0.6591797 vs 0.7158203)
[INFO] [stdout] [2m2026-05-11T20:58:25.110310Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 894.1667 at 44100hZ = 49.319664hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.110468Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.110527Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.110970Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 358 with 711 (0.6484375 vs 0.6816406)
[INFO] [stdout] [2m2026-05-11T20:58:25.113110Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 89.9 at 44100hZ = 490.54504hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.113176Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.113213Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.113690Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 88 with 178 (0.7011719 vs 0.74121094)
[INFO] [stdout] [2m2026-05-11T20:58:25.114572Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 175.37143 at 44100hZ = 251.46628hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.114637Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [242.80092, 245.95432, 251.46628]
[INFO] [stdout] [2m2026-05-11T20:58:25.114679Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.114761Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 245.95432
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.115969Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 367.80002 at 44100hZ = 119.902115hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.116033Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.116065Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.116504Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 93 with 535 (0.51953125 vs 0.5966797)
[INFO] [stdout] [2m2026-05-11T20:58:25.117403Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 172.85713 at 44100hZ = 255.12398hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.117488Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.117529Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.118011Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m Replacing 147 with 451 (0.35351563 vs 0.47558594)
[INFO] [stdout] [2m2026-05-11T20:58:25.118729Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 736.7778 at 44100hZ = 59.855225hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.118798Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.118840Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.119838Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 437.5 at 44100hZ = 100.8hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.121481Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.121567Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Unconfident shift at 0.8388672
[INFO] [stdout] [2m2026-05-11T20:58:25.121607Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.123271Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 198.36363 at 44100hZ = 222.31898hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.123355Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.123394Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.124944Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 348.4 at 44100hZ = 126.57864hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.125121Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.125164Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.127096Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 31 at 44100hZ = 1422.5807hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.127178Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.127220Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Unconfident shift at 0.80078125
[INFO] [stdout] [2m2026-05-11T20:58:25.127305Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.129363Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 16.5 at 44100hZ = 2672.7273hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.129426Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.129509Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Unconfident shift at 0.8125
[INFO] [stdout] [2m2026-05-11T20:58:25.129543Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.131991Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 31 at 44100hZ = 1422.5807hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.132066Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.132102Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.90625
[INFO] [stdout] [2m2026-05-11T20:58:25.132156Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1422.5807, 245.95432, 251.46628]
[INFO] [stdout] [2m2026-05-11T20:58:25.132191Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.132247Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 251.46628
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.132746Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 871.0833 at 44100hZ = 50.626617hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.132810Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.132851Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.133735Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 31 at 44100hZ = 1422.5807hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.133937Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.133997Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.135796Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 31 at 44100hZ = 1422.5807hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.135870Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.135911Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.9375
[INFO] [stdout] [2m2026-05-11T20:58:25.135990Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1422.5807, 1422.5807, 251.46628]
[INFO] [stdout] [2m2026-05-11T20:58:25.136041Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift detected, reset frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.136120Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1422.5807
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.137853Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 31 at 44100hZ = 1422.5807hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.137934Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1422.5807, 1422.5807, 1422.5807]
[INFO] [stdout] [2m2026-05-11T20:58:25.137974Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.138053Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1422.5807
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.138923Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 31 at 44100hZ = 1422.5807hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.138992Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1422.5807, 1422.5807, 1422.5807]
[INFO] [stdout] [2m2026-05-11T20:58:25.139034Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 1
[INFO] [stdout] [2m2026-05-11T20:58:25.139103Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1422.5807
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.141089Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 33.11111 at 44100hZ = 1331.8793hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.141164Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (2)
[INFO] [stdout] [2m2026-05-11T20:58:25.141204Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.9375
[INFO] [stdout] [2m2026-05-11T20:58:25.141263Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1422.5807, 1331.8793, 1422.5807]
[INFO] [stdout] [2m2026-05-11T20:58:25.141300Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 2
[INFO] [stdout] [2m2026-05-11T20:58:25.141370Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1422.5807
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.144723Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 33.11111 at 44100hZ = 1331.8793hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.144803Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (3)
[INFO] [stdout] [2m2026-05-11T20:58:25.144853Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.9375
[INFO] [stdout] [2m2026-05-11T20:58:25.144930Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1422.5807, 1331.8793, 1331.8793]
[INFO] [stdout] [2m2026-05-11T20:58:25.144971Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift detected, reset frames from 3
[INFO] [stdout] [2m2026-05-11T20:58:25.145042Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.147377Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 33.11111 at 44100hZ = 1331.8793hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.147584Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1331.8793, 1331.8793]
[INFO] [stdout] [2m2026-05-11T20:58:25.147741Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.147953Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.150378Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 33.11111 at 44100hZ = 1331.8793hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.150480Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1331.8793, 1331.8793]
[INFO] [stdout] [2m2026-05-11T20:58:25.150517Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 1
[INFO] [stdout] [2m2026-05-11T20:58:25.150586Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.152875Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 153 at 44100hZ = 288.2353hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.152949Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (2)
[INFO] [stdout] [2m2026-05-11T20:58:25.152982Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 1
[INFO] [stdout] [2m2026-05-11T20:58:25.153033Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1331.8793, 288.2353]
[INFO] [stdout] [2m2026-05-11T20:58:25.153079Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 2
[INFO] [stdout] [2m2026-05-11T20:58:25.153115Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.154617Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.155781Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.156586Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m 844 is a subharmonic of 173 (0.8310547 vs 0.8310547)
[INFO] [stdout] [2m2026-05-11T20:58:25.158691Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 33.11111 at 44100hZ = 1331.8793hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.158850Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1331.8793, 288.2353]
[INFO] [stdout] [2m2026-05-11T20:58:25.158907Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.158937Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.159374Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.162400Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 33.11111 at 44100hZ = 1331.8793hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.162508Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1331.8793, 288.2353]
[INFO] [stdout] [2m2026-05-11T20:58:25.162580Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.162625Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.164478Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 926 at 44100hZ = 47.62419hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.164540Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (1)
[INFO] [stdout] [2m2026-05-11T20:58:25.164589Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.9707031
[INFO] [stdout] [2m2026-05-11T20:58:25.164658Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1331.8793, 47.62419]
[INFO] [stdout] [2m2026-05-11T20:58:25.164689Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 1
[INFO] [stdout] [2m2026-05-11T20:58:25.164762Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.167106Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 33.11111 at 44100hZ = 1331.8793hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.167276Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1331.8793, 47.62419]
[INFO] [stdout] [2m2026-05-11T20:58:25.167339Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 2
[INFO] [stdout] [2m2026-05-11T20:58:25.167379Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1331.8793
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.167843Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::period_detector[0m[2m:[0m False correlation check...
[INFO] [stdout] [2m2026-05-11T20:58:25.167916Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.168395Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 87.9 at 44100hZ = 501.70648hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.168484Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.168517Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.169407Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 87.9 at 44100hZ = 501.70648hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.169491Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.169528Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.170012Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.172358Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 38.375 at 44100hZ = 1149.1857hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.172436Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (0)
[INFO] [stdout] [2m2026-05-11T20:58:25.172511Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 0.9375
[INFO] [stdout] [2m2026-05-11T20:58:25.172547Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1149.1857, 47.62419]
[INFO] [stdout] [2m2026-05-11T20:58:25.172606Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift detected, reset frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.172641Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1149.1857
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.176806Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 38.375 at 44100hZ = 1149.1857hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.176892Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [1331.8793, 1149.1857, 1149.1857]
[INFO] [stdout] [2m2026-05-11T20:58:25.176925Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 0
[INFO] [stdout] [2m2026-05-11T20:58:25.176974Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1149.1857
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.179158Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Period 174.66667 at 44100hZ = 252.48091hZ
[INFO] [stdout] [2m2026-05-11T20:58:25.179238Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Not long enough since shift to check for harmonics (1)
[INFO] [stdout] [2m2026-05-11T20:58:25.179273Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Confident shift at 1
[INFO] [stdout] [2m2026-05-11T20:58:25.179323Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::median[0m[2m:[0m Median filter values: [252.48091, 1149.1857, 1149.1857]
[INFO] [stdout] [2m2026-05-11T20:58:25.179368Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::pitch_detector[0m[2m:[0m Shift not detected, increment frames from 1
[INFO] [stdout] [2m2026-05-11T20:58:25.179399Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Found Frequency: 1149.1857
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.179826Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] [2m2026-05-11T20:58:25.180255Z[0m [34mDEBUG[0m [2mbitstream_autocorrelation::tests[0m[2m:[0m Failed to find frequency
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] test tests::test_from_file ... ok
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout] 
[INFO] [stdout] ---- tests::test_from_files stdout ----
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::test_from_files' (19) panicked at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tracing-subscriber-0.3.22/src/fmt/mod.rs:520:14:
[INFO] [stdout] Unable to install global subscriber: SetGlobalDefaultError("a global default trace dispatcher has already been set")
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x5f815262c40a - std[29689e6404d28ef9]::backtrace_rs::backtrace::libunwind::trace
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/../../backtrace/src/backtrace/libunwind.rs:117:9
[INFO] [stdout]    1:     0x5f815262c40a - std[29689e6404d28ef9]::backtrace_rs::backtrace::trace_unsynchronized::<std[29689e6404d28ef9]::sys::backtrace::_print_fmt::{closure#1}>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/../../backtrace/src/backtrace/mod.rs:66:14
[INFO] [stdout]    2:     0x5f815262c40a - std[29689e6404d28ef9]::sys::backtrace::_print_fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:74:9
[INFO] [stdout]    3:     0x5f815262c40a - <<std[29689e6404d28ef9]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[e929cb53b82a81ca]::fmt::Display>::fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:44:26
[INFO] [stdout]    4:     0x5f8152641f8a - <core[e929cb53b82a81ca]::fmt::rt::Argument>::fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/fmt/rt.rs:152:76
[INFO] [stdout]    5:     0x5f8152641f8a - core[e929cb53b82a81ca]::fmt::write
[INFO] [stdout]    6:     0x5f81526310b2 - std[29689e6404d28ef9]::io::default_write_fmt::<alloc[9d7caffeb3b5d2c6]::vec::Vec<u8>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/io/mod.rs:621:11
[INFO] [stdout]    7:     0x5f81526310b2 - <alloc[9d7caffeb3b5d2c6]::vec::Vec<u8> as std[29689e6404d28ef9]::io::Write>::write_fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/io/mod.rs:1976:13
[INFO] [stdout]    8:     0x5f815260a8df - <std[29689e6404d28ef9]::sys::backtrace::BacktraceLock>::print
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:47:9
[INFO] [stdout]    9:     0x5f815260a8df - std[29689e6404d28ef9]::panicking::default_hook::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:292:27
[INFO] [stdout]   10:     0x5f8152624439 - std[29689e6404d28ef9]::panicking::default_hook
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:316:9
[INFO] [stdout]   11:     0x5f815248dabc - <alloc[9d7caffeb3b5d2c6]::boxed::Box<dyn for<'a, 'b> core[e929cb53b82a81ca]::ops::function::Fn<(&'a std[29689e6404d28ef9]::panic::PanicHookInfo<'b>,), Output = ()> + core[e929cb53b82a81ca]::marker::Send + core[e929cb53b82a81ca]::marker::Sync> as core[e929cb53b82a81ca]::ops::function::Fn<(&std[29689e6404d28ef9]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/alloc/src/boxed.rs:2285:9
[INFO] [stdout]   12:     0x5f815248dabc - test[a24b3028667022f7]::test_main_inner::<test[a24b3028667022f7]::test_main_static::{closure#0}>::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:155:21
[INFO] [stdout]   13:     0x5f81526246b2 - <alloc[9d7caffeb3b5d2c6]::boxed::Box<dyn for<'a, 'b> core[e929cb53b82a81ca]::ops::function::Fn<(&'a std[29689e6404d28ef9]::panic::PanicHookInfo<'b>,), Output = ()> + core[e929cb53b82a81ca]::marker::Send + core[e929cb53b82a81ca]::marker::Sync> as core[e929cb53b82a81ca]::ops::function::Fn<(&std[29689e6404d28ef9]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/alloc/src/boxed.rs:2285:9
[INFO] [stdout]   14:     0x5f81526246b2 - std[29689e6404d28ef9]::panicking::panic_with_hook
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:833:13
[INFO] [stdout]   15:     0x5f815260a998 - std[29689e6404d28ef9]::panicking::panic_handler::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:698:13
[INFO] [stdout]   16:     0x5f81525ffae9 - std[29689e6404d28ef9]::sys::backtrace::__rust_end_short_backtrace::<std[29689e6404d28ef9]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:182:18
[INFO] [stdout]   17:     0x5f815260b6ad - __rustc[3aed6af316653e63]::rust_begin_unwind
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:689:5
[INFO] [stdout]   18:     0x5f815264274c - core[e929cb53b82a81ca]::panicking::panic_fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/panicking.rs:80:14
[INFO] [stdout]   19:     0x5f81526424c2 - core[e929cb53b82a81ca]::result::unwrap_failed
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/result.rs:1867:5
[INFO] [stdout]   20:     0x5f815246ef8b - <core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::boxed::Box<dyn core[e929cb53b82a81ca]::error::Error + core[e929cb53b82a81ca]::marker::Send + core[e929cb53b82a81ca]::marker::Sync>>>::expect
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/result.rs:1185:23
[INFO] [stdout]   21:     0x5f8152421850 - <tracing_subscriber[18209f58f154cad6]::fmt::SubscriberBuilder>::init
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tracing-subscriber-0.3.22/src/fmt/mod.rs:520:14
[INFO] [stdout]   22:     0x5f81523d2a06 - bitstream_autocorrelation[a5af74ed797a574b]::tests::test_from_files
[INFO] [stdout]                                at /opt/rustwide/workdir/src/lib.rs:137:14
[INFO] [stdout]   23:     0x5f81523cf777 - bitstream_autocorrelation[a5af74ed797a574b]::tests::test_from_files::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/workdir/src/lib.rs:132:25
[INFO] [stdout]   24:     0x5f815242d946 - <bitstream_autocorrelation[a5af74ed797a574b]::tests::test_from_files::{closure#0} as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   25:     0x5f8152480d9b - <fn() -> core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   26:     0x5f8152480d9b - test[a24b3028667022f7]::__rust_begin_short_backtrace::<core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>, fn() -> core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:724:18
[INFO] [stdout]   27:     0x5f815248e58b - test[a24b3028667022f7]::run_test_in_process::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:747:74
[INFO] [stdout]   28:     0x5f815248e58b - <core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   29:     0x5f815248e58b - std[29689e6404d28ef9]::panicking::catch_unwind::do_call::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}>, core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:581:40
[INFO] [stdout]   30:     0x5f815248e58b - std[29689e6404d28ef9]::panicking::catch_unwind::<core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>, core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:544:19
[INFO] [stdout]   31:     0x5f815248e58b - std[29689e6404d28ef9]::panic::catch_unwind::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}>, core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panic.rs:359:14
[INFO] [stdout]   32:     0x5f815248e58b - test[a24b3028667022f7]::run_test_in_process
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:747:27
[INFO] [stdout]   33:     0x5f815248e58b - test[a24b3028667022f7]::run_test::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:668:43
[INFO] [stdout]   34:     0x5f8152487ca4 - test[a24b3028667022f7]::run_test::{closure#1}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:698:41
[INFO] [stdout]   35:     0x5f8152487ca4 - std[29689e6404d28ef9]::sys::backtrace::__rust_begin_short_backtrace::<test[a24b3028667022f7]::run_test::{closure#1}, ()>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:166:18
[INFO] [stdout]   36:     0x5f8152491192 - std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked::<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/thread/lifecycle.rs:70:13
[INFO] [stdout]   37:     0x5f8152491192 - <core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   38:     0x5f8152491192 - std[29689e6404d28ef9]::panicking::catch_unwind::do_call::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:581:40
[INFO] [stdout]   39:     0x5f8152491192 - std[29689e6404d28ef9]::panicking::catch_unwind::<(), core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:544:19
[INFO] [stdout]   40:     0x5f8152491192 - std[29689e6404d28ef9]::panic::catch_unwind::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panic.rs:359:14
[INFO] [stdout]   41:     0x5f8152491192 - std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked::<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/thread/lifecycle.rs:68:26
[INFO] [stdout]   42:     0x5f8152491192 - <std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1} as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   43:     0x5f815262bcdf - <alloc[9d7caffeb3b5d2c6]::boxed::Box<dyn core[e929cb53b82a81ca]::ops::function::FnOnce<(), Output = ()> + core[e929cb53b82a81ca]::marker::Send> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/alloc/src/boxed.rs:2271:9
[INFO] [stdout]   44:     0x5f815262bcdf - <std[29689e6404d28ef9]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/thread/unix.rs:118:17
[INFO] [stdout]   45:     0x7522913b6aa4 - <unknown>
[INFO] [stdout]   46:     0x752291443a64 - clone
[INFO] [stdout]   47:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- tests::test_with_microphone stdout ----
[INFO] [stdout] Ok(DeviceDescription { name: "Default Audio Device", manufacturer: None, driver: Some("default"), device_type: Unknown, interface_type: Unknown, direction: Unknown, address: None, extended: ["Default Audio Device"] })
[INFO] [stdout] 
[INFO] [stdout] thread 'tests::test_with_microphone' (20) panicked at src/lib.rs:71:64:
[INFO] [stdout] Failed to get device config.: DeviceNotAvailable
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x5f815262c40a - std[29689e6404d28ef9]::backtrace_rs::backtrace::libunwind::trace
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/../../backtrace/src/backtrace/libunwind.rs:117:9
[INFO] [stdout]    1:     0x5f815262c40a - std[29689e6404d28ef9]::backtrace_rs::backtrace::trace_unsynchronized::<std[29689e6404d28ef9]::sys::backtrace::_print_fmt::{closure#1}>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/../../backtrace/src/backtrace/mod.rs:66:14
[INFO] [stdout]    2:     0x5f815262c40a - std[29689e6404d28ef9]::sys::backtrace::_print_fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:74:9
[INFO] [stdout]    3:     0x5f815262c40a - <<std[29689e6404d28ef9]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[e929cb53b82a81ca]::fmt::Display>::fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:44:26
[INFO] [stdout]    4:     0x5f8152641f8a - <core[e929cb53b82a81ca]::fmt::rt::Argument>::fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/fmt/rt.rs:152:76
[INFO] [stdout]    5:     0x5f8152641f8a - core[e929cb53b82a81ca]::fmt::write
[INFO] [stdout]    6:     0x5f81526310b2 - std[29689e6404d28ef9]::io::default_write_fmt::<alloc[9d7caffeb3b5d2c6]::vec::Vec<u8>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/io/mod.rs:621:11
[INFO] [stdout]    7:     0x5f81526310b2 - <alloc[9d7caffeb3b5d2c6]::vec::Vec<u8> as std[29689e6404d28ef9]::io::Write>::write_fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/io/mod.rs:1976:13
[INFO] [stdout]    8:     0x5f815260a8df - <std[29689e6404d28ef9]::sys::backtrace::BacktraceLock>::print
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:47:9
[INFO] [stdout]    9:     0x5f815260a8df - std[29689e6404d28ef9]::panicking::default_hook::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:292:27
[INFO] [stdout]   10:     0x5f8152624439 - std[29689e6404d28ef9]::panicking::default_hook
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:316:9
[INFO] [stdout]   11:     0x5f815248dabc - <alloc[9d7caffeb3b5d2c6]::boxed::Box<dyn for<'a, 'b> core[e929cb53b82a81ca]::ops::function::Fn<(&'a std[29689e6404d28ef9]::panic::PanicHookInfo<'b>,), Output = ()> + core[e929cb53b82a81ca]::marker::Send + core[e929cb53b82a81ca]::marker::Sync> as core[e929cb53b82a81ca]::ops::function::Fn<(&std[29689e6404d28ef9]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/alloc/src/boxed.rs:2285:9
[INFO] [stdout]   12:     0x5f815248dabc - test[a24b3028667022f7]::test_main_inner::<test[a24b3028667022f7]::test_main_static::{closure#0}>::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:155:21
[INFO] [stdout]   13:     0x5f81526246b2 - <alloc[9d7caffeb3b5d2c6]::boxed::Box<dyn for<'a, 'b> core[e929cb53b82a81ca]::ops::function::Fn<(&'a std[29689e6404d28ef9]::panic::PanicHookInfo<'b>,), Output = ()> + core[e929cb53b82a81ca]::marker::Send + core[e929cb53b82a81ca]::marker::Sync> as core[e929cb53b82a81ca]::ops::function::Fn<(&std[29689e6404d28ef9]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/alloc/src/boxed.rs:2285:9
[INFO] [stdout]   14:     0x5f81526246b2 - std[29689e6404d28ef9]::panicking::panic_with_hook
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:833:13
[INFO] [stdout]   15:     0x5f815260a998 - std[29689e6404d28ef9]::panicking::panic_handler::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:698:13
[INFO] [stdout]   16:     0x5f81525ffae9 - std[29689e6404d28ef9]::sys::backtrace::__rust_end_short_backtrace::<std[29689e6404d28ef9]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:182:18
[INFO] [stdout]   17:     0x5f815260b6ad - __rustc[3aed6af316653e63]::rust_begin_unwind
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:689:5
[INFO] [stdout]   18:     0x5f815264274c - core[e929cb53b82a81ca]::panicking::panic_fmt
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/panicking.rs:80:14
[INFO] [stdout]   19:     0x5f81526424c2 - core[e929cb53b82a81ca]::result::unwrap_failed
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/result.rs:1867:5
[INFO] [stdout]   20:     0x5f815243db8f - <core[e929cb53b82a81ca]::result::Result<cpal[2c1a97f2e3d92db9]::SupportedStreamConfig, cpal[2c1a97f2e3d92db9]::error::DefaultStreamConfigError>>::expect
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/result.rs:1185:23
[INFO] [stdout]   21:     0x5f81523cfbb7 - bitstream_autocorrelation[a5af74ed797a574b]::tests::test_with_microphone::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/workdir/src/lib.rs:71:64
[INFO] [stdout]   22:     0x5f81523fb972 - <core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>> as core[e929cb53b82a81ca]::future::future::Future>::poll
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/future/future.rs:133:9
[INFO] [stdout]   23:     0x5f81523ddaed - <tokio[31db0a1d05fe6e22]::runtime::park::CachedParkThread>::block_on::<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/park.rs:284:71
[INFO] [stdout]   24:     0x5f81523db302 - tokio[31db0a1d05fe6e22]::task::coop::with_budget::<core[e929cb53b82a81ca]::task::poll::Poll<()>, <tokio[31db0a1d05fe6e22]::runtime::park::CachedParkThread>::block_on<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>::{closure#0}>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/task/coop/mod.rs:167:5
[INFO] [stdout]   25:     0x5f81523db302 - tokio[31db0a1d05fe6e22]::task::coop::budget::<core[e929cb53b82a81ca]::task::poll::Poll<()>, <tokio[31db0a1d05fe6e22]::runtime::park::CachedParkThread>::block_on<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>::{closure#0}>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/task/coop/mod.rs:133:5
[INFO] [stdout]   26:     0x5f81523db302 - <tokio[31db0a1d05fe6e22]::runtime::park::CachedParkThread>::block_on::<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/park.rs:284:31
[INFO] [stdout]   27:     0x5f815243bcc4 - <tokio[31db0a1d05fe6e22]::runtime::context::blocking::BlockingRegionGuard>::block_on::<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/context/blocking.rs:66:14
[INFO] [stdout]   28:     0x5f815242c688 - <tokio[31db0a1d05fe6e22]::runtime::scheduler::multi_thread::MultiThread>::block_on::<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/scheduler/multi_thread/mod.rs:89:22
[INFO] [stdout]   29:     0x5f81523dd70b - tokio[31db0a1d05fe6e22]::runtime::context::runtime::enter_runtime::<<tokio[31db0a1d05fe6e22]::runtime::scheduler::multi_thread::MultiThread>::block_on<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>::{closure#0}, ()>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/context/runtime.rs:65:16
[INFO] [stdout]   30:     0x5f8152428294 - <tokio[31db0a1d05fe6e22]::runtime::scheduler::multi_thread::MultiThread>::block_on::<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/scheduler/multi_thread/mod.rs:88:9
[INFO] [stdout]   31:     0x5f815242e7a4 - <tokio[31db0a1d05fe6e22]::runtime::runtime::Runtime>::block_on_inner::<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/runtime.rs:370:50
[INFO] [stdout]   32:     0x5f815242e99f - <tokio[31db0a1d05fe6e22]::runtime::runtime::Runtime>::block_on::<core[e929cb53b82a81ca]::pin::Pin<&mut dyn core[e929cb53b82a81ca]::future::future::Future<Output = ()>>>
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/tokio-1.49.0/src/runtime/runtime.rs:342:18
[INFO] [stdout]   33:     0x5f81523d30f3 - bitstream_autocorrelation[a5af74ed797a574b]::tests::test_with_microphone
[INFO] [stdout]                                at /opt/rustwide/workdir/src/lib.rs:120:27
[INFO] [stdout]   34:     0x5f81523cf7a7 - bitstream_autocorrelation[a5af74ed797a574b]::tests::test_with_microphone::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/workdir/src/lib.rs:67:36
[INFO] [stdout]   35:     0x5f815242d986 - <bitstream_autocorrelation[a5af74ed797a574b]::tests::test_with_microphone::{closure#0} as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   36:     0x5f8152480d9b - <fn() -> core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   37:     0x5f8152480d9b - test[a24b3028667022f7]::__rust_begin_short_backtrace::<core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>, fn() -> core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:724:18
[INFO] [stdout]   38:     0x5f815248e58b - test[a24b3028667022f7]::run_test_in_process::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:747:74
[INFO] [stdout]   39:     0x5f815248e58b - <core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   40:     0x5f815248e58b - std[29689e6404d28ef9]::panicking::catch_unwind::do_call::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}>, core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:581:40
[INFO] [stdout]   41:     0x5f815248e58b - std[29689e6404d28ef9]::panicking::catch_unwind::<core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>, core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:544:19
[INFO] [stdout]   42:     0x5f815248e58b - std[29689e6404d28ef9]::panic::catch_unwind::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<test[a24b3028667022f7]::run_test_in_process::{closure#0}>, core[e929cb53b82a81ca]::result::Result<(), alloc[9d7caffeb3b5d2c6]::string::String>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panic.rs:359:14
[INFO] [stdout]   43:     0x5f815248e58b - test[a24b3028667022f7]::run_test_in_process
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:747:27
[INFO] [stdout]   44:     0x5f815248e58b - test[a24b3028667022f7]::run_test::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:668:43
[INFO] [stdout]   45:     0x5f8152487ca4 - test[a24b3028667022f7]::run_test::{closure#1}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/test/src/lib.rs:698:41
[INFO] [stdout]   46:     0x5f8152487ca4 - std[29689e6404d28ef9]::sys::backtrace::__rust_begin_short_backtrace::<test[a24b3028667022f7]::run_test::{closure#1}, ()>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/backtrace.rs:166:18
[INFO] [stdout]   47:     0x5f8152491192 - std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked::<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/thread/lifecycle.rs:70:13
[INFO] [stdout]   48:     0x5f8152491192 - <core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   49:     0x5f8152491192 - std[29689e6404d28ef9]::panicking::catch_unwind::do_call::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:581:40
[INFO] [stdout]   50:     0x5f8152491192 - std[29689e6404d28ef9]::panicking::catch_unwind::<(), core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panicking.rs:544:19
[INFO] [stdout]   51:     0x5f8152491192 - std[29689e6404d28ef9]::panic::catch_unwind::<core[e929cb53b82a81ca]::panic::unwind_safe::AssertUnwindSafe<std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/panic.rs:359:14
[INFO] [stdout]   52:     0x5f8152491192 - std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked::<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/thread/lifecycle.rs:68:26
[INFO] [stdout]   53:     0x5f8152491192 - <std[29689e6404d28ef9]::thread::lifecycle::spawn_unchecked<test[a24b3028667022f7]::run_test::{closure#1}, ()>::{closure#1} as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   54:     0x5f815262bcdf - <alloc[9d7caffeb3b5d2c6]::boxed::Box<dyn core[e929cb53b82a81ca]::ops::function::FnOnce<(), Output = ()> + core[e929cb53b82a81ca]::marker::Send> as core[e929cb53b82a81ca]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/alloc/src/boxed.rs:2271:9
[INFO] [stdout]   55:     0x5f815262bcdf - <std[29689e6404d28ef9]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]                                at /rustc/ec6f9a5b4413f74386267ef8efc93712c2ce6db6/library/std/src/sys/thread/unix.rs:118:17
[INFO] [stdout]   56:     0x7522913b6aa4 - <unknown>
[INFO] [stdout]   57:     0x752291443a64 - clone
[INFO] [stdout]   58:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout]     tests::test_from_files
[INFO] [stdout]     tests::test_with_microphone
[INFO] [stdout] 
[INFO] [stdout] test result: FAILED. 1 passed; 2 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.25s
[INFO] [stdout] 
[INFO] [stderr] error: test failed, to rerun pass `--lib`
[INFO] running `Command { std: "docker" "inspect" "1974bced333daa13c1ff5754f83e9257df51025dce3be8594b631729a9f90630", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "1974bced333daa13c1ff5754f83e9257df51025dce3be8594b631729a9f90630", kill_on_drop: false }`
[INFO] [stdout] 1974bced333daa13c1ff5754f83e9257df51025dce3be8594b631729a9f90630
