[INFO] fetching crate rtrack-core 0.1.3...
[INFO] testing rtrack-core-0.1.3 against 1.100.0-beta.1 for beta-1.100-2
[INFO] extracting crate rtrack-core 0.1.3 into /workspace/builds/worker-0-tc2/source
[INFO] started tweaking crates.io crate rtrack-core 0.1.3
[INFO] removed 0 missing tests
[INFO] finished tweaking crates.io crate rtrack-core 0.1.3
[INFO] tweaked toml for crates.io crate rtrack-core 0.1.3 written to /workspace/builds/worker-0-tc2/source/Cargo.toml
[INFO] validating manifest of crates.io crate rtrack-core 0.1.3 on toolchain 1.100.0-beta.1
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.100.0-beta.1" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate crates.io crate rtrack-core 0.1.3 already has a lockfile, it will not be regenerated
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.100.0-beta.1" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-0-tc2/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-0-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-m" "1610612736" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:3111399a4047eeb3a02b7a90e478d715f38a8c6669b5c4b49d30a17385265909" "sleep" "infinity", kill_on_drop: false }`
[INFO] [stdout] 199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4
[INFO] running `Command { std: "docker" "start" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-w" "/opt/rustwide/workdir" "--user" "0:0" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stderr]    Compiling bytemuck v1.25.2
[INFO] [stderr]    Compiling arrayvec v0.7.8
[INFO] [stderr]    Compiling syn v2.0.119
[INFO] [stderr]    Compiling syn v3.0.3
[INFO] [stderr]    Compiling bitflags v2.13.1
[INFO] [stderr]    Compiling typenum v1.20.1
[INFO] [stderr]    Compiling getrandom v0.4.3
[INFO] [stderr]    Compiling rustix v1.1.4
[INFO] [stderr]    Compiling glob v0.3.4
[INFO] [stderr]    Compiling linux-raw-sys v0.12.1
[INFO] [stderr]    Compiling symphonia-core v0.5.5
[INFO] [stderr]    Compiling dasp_frame v0.11.0
[INFO] [stderr]    Compiling once_cell v1.21.4
[INFO] [stderr]    Compiling clang-sys v1.9.1
[INFO] [stderr]    Compiling fastrand v2.5.0
[INFO] [stderr]    Compiling prettyplease v0.2.37
[INFO] [stderr]    Compiling num-integer v0.1.47
[INFO] [stderr]    Compiling num_cpus v1.17.0
[INFO] [stderr]    Compiling zerocopy v0.8.56
[INFO] [stderr]    Compiling pkg-config v0.3.34
[INFO] [stderr]    Compiling regex-syntax v0.8.11
[INFO] [stderr]    Compiling symphonia-metadata v0.5.5
[INFO] [stderr]    Compiling generic-array v0.14.7
[INFO] [stderr]    Compiling symphonia-utils-xiph v0.5.5
[INFO] [stderr]    Compiling alsa-sys v0.3.1
[INFO] [stderr]    Compiling nom v7.1.3
[INFO] [stderr]    Compiling num-complex v0.4.6
[INFO] [stderr]    Compiling ahash v0.8.12
[INFO] [stderr]    Compiling libloading v0.8.9
[INFO] [stderr]    Compiling dasp_ring_buffer v0.11.0
[INFO] [stderr]    Compiling bindgen v0.72.1
[INFO] [stderr]    Compiling either v1.18.0
[INFO] [stderr]    Compiling find-msvc-tools v0.1.11
[INFO] [stderr]    Compiling itertools v0.13.0
[INFO] [stderr]    Compiling cc v1.4.4
[INFO] [stderr]    Compiling tempfile v3.27.0
[INFO] [stderr]    Compiling serde_derive v1.0.229
[INFO] [stderr]    Compiling regex-automata v0.4.18
[INFO] [stderr]    Compiling cexpr v0.6.0
[INFO] [stderr]    Compiling transpose v0.2.3
[INFO] [stderr]    Compiling rtsan-standalone-sys v0.3.0
[INFO] [stderr]    Compiling primal-check v0.3.4
[INFO] [stderr]    Compiling thiserror v2.0.20
[INFO] [stderr]    Compiling rustc-hash v2.1.3
[INFO] [stderr]    Compiling rtsan-standalone v0.3.0
[INFO] [stderr]    Compiling crossbeam-utils v0.8.22
[INFO] [stderr]    Compiling rustfft v6.4.1
[INFO] [stderr]    Compiling cmake v0.1.58
[INFO] [stderr]    Compiling thiserror-impl v2.0.20
[INFO] [stderr]    Compiling regex v1.13.1
[INFO] [stderr]    Compiling dasp_rms v0.11.0
[INFO] [stderr]    Compiling block-buffer v0.10.4
[INFO] [stderr]    Compiling crypto-common v0.1.7
[INFO] [stderr]    Compiling dasp_peak v0.11.0
[INFO] [stderr]    Compiling byteorder v1.5.0
[INFO] [stderr]    Compiling rtsan-standalone-macros v0.3.0
[INFO] [stderr]    Compiling pin-project-internal v1.1.13
[INFO] [stderr]    Compiling built v0.7.7
[INFO] [stderr]    Compiling heapless v0.8.0
[INFO] [stderr]    Compiling serde v1.0.229
[INFO] [stderr]    Compiling symphonia-format-riff v0.5.5
[INFO] [stderr]    Compiling flacenc v0.5.1
[INFO] [stderr]    Compiling hash32 v0.3.1
[INFO] [stderr]    Compiling alsa v0.9.1
[INFO] [stderr]    Compiling dasp_envelope v0.11.0
[INFO] [stderr]    Compiling digest v0.10.7
[INFO] [stderr]    Compiling serde_spanned v0.6.9
[INFO] [stderr]    Compiling toml_datetime v0.6.11
[INFO] [stderr]    Compiling generic-array v1.4.5
[INFO] [stderr]    Compiling dasp_interpolate v0.11.0
[INFO] [stderr]    Compiling symphonia-format-ogg v0.5.5
[INFO] [stderr]    Compiling pin-project v1.1.13
[INFO] [stderr]    Compiling symphonia-format-mkv v0.5.5
[INFO] [stderr]    Compiling symphonia-codec-vorbis v0.5.5
[INFO] [stderr]    Compiling symphonia-format-isomp4 v0.5.5
[INFO] [stderr]    Compiling hashbrown v0.14.5
[INFO] [stderr]    Compiling symphonia-bundle-flac v0.5.5
[INFO] [stderr]    Compiling symphonia-format-caf v0.5.5
[INFO] [stderr]    Compiling symphonia-bundle-mp3 v0.5.5
[INFO] [stderr]    Compiling symphonia-codec-aac v0.5.5
[INFO] [stderr]    Compiling symphonia-codec-pcm v0.5.5
[INFO] [stderr]    Compiling symphonia-codec-adpcm v0.5.5
[INFO] [stderr]    Compiling symphonia-codec-alac v0.5.5
[INFO] [stderr]    Compiling safe_arch v1.2.0
[INFO] [stderr]    Compiling dasp_window v0.11.1
[INFO] [stderr]    Compiling glam v0.28.0
[INFO] [stderr]    Compiling foldhash v0.2.0
[INFO] [stderr]    Compiling cpal v0.15.3
[INFO] [stderr]    Compiling microfft v0.6.0
[INFO] [stderr]    Compiling wide v1.6.1
[INFO] [stderr]    Compiling toml_edit v0.22.27
[INFO] [stderr]    Compiling symphonia v0.5.5
[INFO] [stderr]    Compiling realfft v3.5.0
[INFO] [stderr]    Compiling fft-convolver v0.3.0
[INFO] [stderr]    Compiling hashbrown v0.16.1
[INFO] [stderr]    Compiling dasp_signal v0.11.0
[INFO] [stderr]    Compiling numeric-array v0.6.1
[INFO] [stderr]    Compiling crossbeam-channel v0.5.16
[INFO] [stderr]    Compiling thingbuf v0.1.6
[INFO] [stderr]    Compiling md-5 v0.10.6
[INFO] [stderr]    Compiling dasp_slice v0.11.0
[INFO] [stderr]    Compiling resampler v0.4.1
[INFO] [stderr]    Compiling seq-macro v0.3.6
[INFO] [stderr]    Compiling serde_json v1.0.151
[INFO] [stderr]    Compiling dasp v0.11.0
[INFO] [stderr]    Compiling midir v0.10.4
[INFO] [stderr]    Compiling hound v3.5.1
[INFO] [stderr]    Compiling rtrb v0.3.5
[INFO] [stderr]    Compiling rustysynth v1.3.6
[INFO] [stderr]    Compiling funutd v0.16.0
[INFO] [stderr]    Compiling toml v0.8.23
[INFO] [stderr]    Compiling rusty_link v0.4.9
[INFO] [stderr]    Compiling fundsp v0.23.0
[INFO] [stderr]    Compiling rtrack-core v0.1.3 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `dev` profile [unoptimized + debuginfo] target(s) in 2m 42s
[INFO] running `Command { std: "docker" "inspect" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stderr]    Compiling rustix v1.1.4
[INFO] [stderr]    Compiling ahash v0.8.12
[INFO] [stderr]    Compiling bindgen v0.72.1
[INFO] [stderr]    Compiling alsa v0.9.1
[INFO] [stderr]    Compiling hashbrown v0.14.5
[INFO] [stderr]    Compiling funutd v0.16.0
[INFO] [stderr]    Compiling midir v0.10.4
[INFO] [stderr]    Compiling cpal v0.15.3
[INFO] [stderr]    Compiling tempfile v3.27.0
[INFO] [stderr]    Compiling rtsan-standalone-sys v0.3.0
[INFO] [stderr]    Compiling rtsan-standalone v0.3.0
[INFO] [stderr]    Compiling fft-convolver v0.3.0
[INFO] [stderr]    Compiling fundsp v0.23.0
[INFO] [stderr]    Compiling rusty_link v0.4.9
[INFO] [stderr]    Compiling rtrack-core v0.1.3 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 1m 34s
[INFO] running `Command { std: "docker" "inspect" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "test" "--frozen", kill_on_drop: false }`
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 0.36s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/debug/build/rtrack-core/20147cd314db377d/out/rtrack_core-20147cd314db377d)
[INFO] [stdout] 
[INFO] [stdout] running 315 tests
[INFO] [stdout] test audio::channel_effects::tests::test_channel_effects_default_passthrough ... ok
[INFO] [stdout] test audio::channel_effects::tests::test_chorus_produces_output ... ok
[INFO] [stdout] test audio::channel_effects::tests::test_reset_clears_state ... ok
[INFO] [stdout] test audio::channel_effects::tests::test_full_chain ... ok
[INFO] [stdout] test audio::effects::tests::test_effects_chain_creates ... ok
[INFO] [stdout] test audio::effects::tests::test_send_bus_add_send_accumulates ... ok
[INFO] [stdout] test audio::effects::tests::test_effects_chain_disabled ... ok
[INFO] [stdout] test audio::effects::tests::test_effects_chain_processes_silence ... ok
[INFO] [stdout] test audio::effects::tests::test_send_bus_creates ... ok
[INFO] [stdout] test audio::effects::tests::test_send_bus_disabled_produces_silence ... ok
[INFO] [stdout] test audio::channel_effects::tests::test_delay_produces_echo ... ok
[INFO] [stdout] test audio::channel_effects::tests::test_filter_reduces_highs ... ok
[INFO] [stdout] test audio::envelope::tests::test_envelope_release ... ok
[INFO] [stdout] test audio::envelope::tests::test_envelope_sample_default ... ok
[INFO] [stdout] test audio::envelope::tests::test_envelope_attack_decay_sustain ... ok
[INFO] [stdout] test audio::channel_effects::tests::test_distortion_increases_harmonics ... ok
[INFO] [stdout] test audio::envelope::tests::test_release_from_off_is_noop ... ok
[INFO] [stdout] test audio::envelope::tests::test_envelope_zero_release ... ok
[INFO] [stdout] test audio::envelope::tests::test_envelope_zero_attack ... ok
[INFO] [stdout] test audio::effects::tests::test_send_bus_delay_produces_output ... ok
[INFO] [stdout] test audio::channel_effects::tests::test_reverb_produces_tail ... ok
[INFO] [stdout] test audio::effects::tests::test_send_bus_reverb_produces_output ... ok
[INFO] [stdout] test audio::scheduler_tests::a_note_scheduled_mid_buffer_starts_at_that_sample ... ok
[INFO] [stdout] test audio::scheduler_tests::a_command_inserted_out_of_order_lands_on_its_own_frame ... ok
[INFO] [stdout] test audio::scheduler_tests::an_oversized_callback_is_counted ... ok
[INFO] [stdout] test audio::scheduler_tests::an_empty_segment_renders_nothing_and_does_not_panic ... ok
[INFO] [stdout] test audio::scheduler_tests::a_command_due_in_a_later_block_lands_on_its_own_frame ... ok
[INFO] [stdout] test audio::scheduler_tests::commands_that_do_not_fit_the_queue_are_counted ... ok
[INFO] [stdout] test audio::scheduler_tests::commands_applied_ahead_of_their_frame_are_counted ... ok
[INFO] [stdout] test audio::scheduler_tests::a_split_callback_renders_the_same_audio_as_one_pass ... ok
[INFO] [stdout] test audio::scheduler_tests::finished_values_are_handed_back_instead_of_freed ... ok
[INFO] [stdout] test audio::scheduler_tests::implausible_or_absent_buffer_ranges_fall_back ... ok
[INFO] [stdout] test audio::scheduler_tests::commands_due_together_are_applied_in_frame_order ... ok
[INFO] [stdout] test audio::scheduler_tests::an_oversized_callback_does_not_grow_the_scratch_buffers ... ok
[INFO] [stdout] test audio::scheduler_tests::render_buffers_are_sized_from_the_device_buffer_range ... ok
[INFO] [stdout] test audio::scheduler_tests::the_pending_list_is_ordered_by_frame_and_stable_within_a_frame ... ok
[INFO] [stdout] test audio::scheduler_tests::an_oversized_callback_through_a_send_bus_does_not_allocate ... ok
[INFO] [stdout] test audio::scheduler_tests::handing_back_still_installs_the_new_parameters ... ok
[INFO] [stdout] test audio::scheduler_tests::values_for_out_of_range_targets_are_still_handed_back ... ok
[INFO] [stdout] test audio::scheduler_tests::segmented_rendering_matches_whole_buffer_rendering ... ok
[INFO] [stdout] test audio::scheduler_tests::segmented_rendering_matches_with_channel_effects_engaged ... ok
[INFO] [stdout] test audio::synth::fundsp_pool_tests::non_pad_patches_leave_the_pool_untouched ... ok
[INFO] [stdout] test audio::synth::fundsp_pool_tests::retuning_updates_the_shared_frequency ... ok
[INFO] [stdout] test audio::synth::fundsp_pool_tests::the_pool_is_prebuilt_so_note_on_never_allocates_a_graph ... ok
[INFO] [stdout] test audio::synth::fundsp_pool_tests::evicted_voices_return_their_graph_to_the_pool ... ok
[INFO] [stdout] test audio::synth::fundsp_pool_tests::a_recycled_graph_is_retuned_rather_than_reused_stale ... ok
[INFO] [stdout] test audio::synth::fundsp_pool_tests::a_pad_note_takes_a_graph_from_the_pool_and_sounds ... ok
[INFO] [stdout] test audio::synth::tests::test_adsr_envelope_shape ... ok
[INFO] [stdout] test audio::synth::tests::test_midi_to_freq ... ok
[INFO] [stdout] test audio::synth::tests::test_note_off_fade_behavior ... ok
[INFO] [stdout] test audio::synth::tests::test_note_on_with_custom_params ... ok
[INFO] [stdout] test audio::scheduler_tests::segmented_rendering_matches_with_send_buses_engaged ... ok
[INFO] [stdout] test audio::synth::tests::test_patch_from_program ... ok
[INFO] [stdout] test audio::scheduler_tests::without_scheduling_a_note_would_start_at_the_buffer_boundary ... ok
[INFO] [stdout] test audio::synth::tests::test_program_change ... ok
[INFO] [stdout] test audio::synth::tests::test_polyblep_saw_no_dc_offset ... ok
[INFO] [stdout] test audio::synth::tests::test_render_output_levels ... ok
[INFO] [stdout] test audio::synth::tests::test_synth_params_from_patch ... ok
[INFO] [stdout] test audio::synth::tests::test_synth_note_off_channel ... ok
[INFO] [stdout] test audio::synth::tests::test_synth_same_channel_replaces_note ... ok
[INFO] [stdout] test audio::synth::tests::test_synth_polyphony_across_channels ... ok
[INFO] [stdout] test audio::synth::tests::test_filter_affects_brightness ... ok
[INFO] [stdout] test audio::synth::tests::test_velocity_affects_output ... ok
[INFO] [stdout] test audio::synth::tests::test_synth_voice_lifecycle ... ok
[INFO] [stderr] ALSA lib confmisc.c:855:(parse_card) [error.core] cannot find card '0'
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_card_inum returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:422:(snd_func_concat) [error.core] error evaluating strings
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_concat returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:1342:(snd_func_refer) [error.core] error evaluating name
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_refer returned error: No such file or directory
[INFO] [stderr] ALSA lib conf.c:5734:(snd_config_expand) [error.core] Evaluate error: No such file or directory
[INFO] [stderr] ALSA lib pcm.c:2722:(snd_pcm_open_noupdate) [error.pcm] Unknown PCM default
[INFO] [stderr] ALSA lib confmisc.c:855:(parse_card) [error.core] cannot find card '0'
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_card_inum returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:422:(snd_func_concat) [error.core] error evaluating strings
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_concat returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:1342:(snd_func_refer) [error.core] error evaluating name
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_refer returned error: No such file or directory
[INFO] [stderr] ALSA lib conf.c:5734:(snd_config_expand) [error.core] Evaluate error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:855:(parse_card) ALSA lib pcm.c:2722:(snd_pcm_open_noupdate) [error.pcm] Unknown PCM default
[INFO] [stderr] [error.core] cannot find card '0'
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_card_inum returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:422:(snd_func_concat) [error.core] error evaluating strings
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_concat returned error: No such file or directory
[INFO] [stderr] ALSA lib confmisc.c:1342:(snd_func_refer) [error.core] error evaluating name
[INFO] [stderr] ALSA lib conf.c:5211:(_snd_config_evaluate) [error.core] function snd_func_refer returned error: No such file or directory
[INFO] [stderr] ALSA lib conf.c:5734:(snd_config_expand) [error.core] Evaluate error: No such file or directory
[INFO] [stderr] ALSA lib pcm.c:2722:(snd_pcm_open_noupdate) [error.pcm] Unknown PCM default
[INFO] [stdout] test audio::tests::test_audio_engine_requires_valid_sf2 ... ok
[INFO] [stdout] test audio::tests::test_callback_interleaving ... ok
[INFO] [stdout] test audio::tests::test_system_audio_config ... ok
[INFO] [stdout] test config::tests::test_load_config_missing_file ... ok
[INFO] [stdout] test audio::effects::tests::test_effects_chain_signal_levels ... ok
[INFO] [stdout] test config::tests::test_parse_invalid_toml_returns_default ... ok
[INFO] [stdout] test config::tests::test_parse_empty_config ... ok
[INFO] [stdout] test config::tests::test_parse_full_config ... ok
[INFO] [stdout] test config::tests::test_push_recent_file_adds_to_front ... ok
[INFO] [stdout] test config::tests::test_parse_partial_config ... ok
[INFO] [stdout] test config::tests::test_push_recent_file_deduplicates ... ok
[INFO] [stdout] test config::tests::test_unknown_fields_ignored ... ok
[INFO] [stdout] test config::tests::test_push_recent_file_truncates ... ok
[INFO] [stdout] test core::tests::an_empty_column_resolves_to_nothing ... ok
[INFO] [stdout] test core::tests::a_saved_song_autosaves_beside_itself ... ok
[INFO] [stdout] test core::tests::editing_inherits_the_instrument_from_the_column_above ... ok
[INFO] [stdout] test core::tests::an_unsaved_song_does_not_autosave_into_the_working_directory ... ok
[INFO] [stdout] test core::tests::frames_per_tick_never_returns_zero ... ok
[INFO] [stdout] test core::tests::frames_per_tick_matches_the_tick_rate ... ok
[INFO] [stdout] test core::tests::expiring_positions_keeps_the_most_recent_audible_one ... ok
[INFO] [stdout] test core::tests::midi_tracks_do_not_pick_up_a_track_default ... ok
[INFO] [stdout] test core::tests::recorded_notes_inherit_the_instrument_from_the_column_above ... ok
[INFO] [stdout] test core::tests::recorded_notes_still_honour_a_track_default ... ok
[INFO] [stdout] test core::tests::out_of_range_coordinates_resolve_to_nothing ... ok
[INFO] [stdout] test core::tests::resolution_is_per_channel ... ok
[INFO] [stdout] test core::tests::resolution_does_not_reach_across_order_positions ... ok
[INFO] [stdout] test core::tests::scheduled_positions_are_capped ... ok
[INFO] [stdout] test core::tests::playback_position_falls_back_to_the_engine_without_audio ... ok
[INFO] [stderr] ALSA lib seq_hw.c:540:(snd_seq_hw_open) [error.sequencer] open /dev/snd/seq failed: No such file or directory
[INFO] [stdout] test core::tests::a_cells_own_instrument_is_kept_when_re_entering_a_note ... ok
[INFO] [stderr] ALSA lib seq_hw.c:540:(snd_seq_hw_open) [error.sequencer] open /dev/snd/seq failed: No such file or directory
[INFO] [stderr] ALSA lib seq_hw.c:540:(snd_seq_hw_open) [error.sequencer] open /dev/snd/seq failed: No such file or directory
[INFO] [stderr] ALSA lib seq_hw.c:540:(snd_seq_hw_open) [error.sequencer] open /dev/snd/seq failed: No such file or directory
[INFO] [stderr] ALSA lib seq_hw.c:540:(snd_seq_hw_open) [error.sequencer] open /dev/snd/seq failed: No such file or directory
[INFO] [stderr] ALSA lib seq_hw.c:540:(snd_seq_hw_open) [error.sequencer] open /dev/snd/seq failed: No such file or directory
[INFO] [stdout] test core::tests::test_builder_custom_song_size ... ok
[INFO] [stdout] test core::tests::test_builder_default_matches_new ... ok
[INFO] [stdout] test core::tests::saving_an_unsaved_song_removes_the_recovery_copy_it_left_in_temp ... ok
[INFO] [stdout] test audio::scheduler_tests::a_large_block_does_not_grow_the_send_bus_buffers ... ok
[INFO] [stdout] test audio::tests::test_no_buffer_boundary_clicks ... ok
[INFO] [stdout] test core::tests::stopping_discards_positions_queued_ahead_of_the_clock ... ok
[INFO] [stdout] test core::tests::ticks_accumulate_to_the_right_rate_over_a_bar ... ok
[INFO] [stdout] test editor::tests::a_block_and_a_run_do_not_displace_each_other ... ok
[INFO] [stdout] test editor::tests::a_coalesced_run_still_clears_the_redo_branch ... ok
[INFO] [stdout] test core::tests::test_builder_injected_midi ... ok
[INFO] [stdout] test editor::tests::a_fresh_clipboard_is_empty_and_clears_back_to_empty ... ok
[INFO] [stdout] test editor::tests::a_group_is_one_step_and_costs_the_sum_of_its_parts ... ok
[INFO] [stdout] test editor::tests::a_run_of_edits_to_one_control_is_a_single_step ... ok
[INFO] [stdout] test editor::tests::a_single_cell_and_a_row_share_one_slot ... ok
[INFO] [stdout] test core::tests::test_builder_headless ... ok
[INFO] [stdout] test editor::tests::a_step_bigger_than_the_budget_is_still_kept ... ok
[INFO] [stdout] test editor::tests::an_edit_that_changed_nothing_is_not_a_step ... ok
[INFO] [stdout] test editor::tests::a_structural_change_round_trips_through_the_same_history_as_cells ... ok
[INFO] [stdout] test editor::tests::an_unrelated_edit_between_two_runs_keeps_them_apart ... ok
[INFO] [stdout] test editor::tests::breaking_coalescing_starts_a_new_step_for_the_same_control ... ok
[INFO] [stdout] test editor::tests::cell_edits_do_not_coalesce_even_from_one_source ... ok
[INFO] [stdout] test editor::tests::clearing_drops_both_directions ... ok
[INFO] [stdout] test editor::tests::editing_after_an_undo_discards_the_branch_that_was_undone ... ok
[INFO] [stdout] test editor::tests::coalescing_does_not_grow_the_history ... ok
[INFO] [stdout] test editor::tests::edits_to_different_controls_are_separate_steps ... ok
[INFO] [stdout] test editor::tests::next_and_prev_are_inverses_for_every_field ... ok
[INFO] [stdout] test editor::tests::steps_of_different_kinds_describe_themselves ... ok
[INFO] [stdout] test editor::tests::sub_columns_walk_left_and_wrap ... ok
[INFO] [stdout] test editor::tests::sub_columns_walk_right_and_wrap ... ok
[INFO] [stdout] test editor::tests::the_history_stays_inside_its_byte_budget ... ok
[INFO] [stdout] test editor::tests::the_oldest_step_falls_off_when_the_step_ceiling_is_reached ... ok
[INFO] [stdout] test editor::tests::the_index_keeps_instances_of_one_control_apart ... ok
[INFO] [stdout] test editor::tests::undoing_and_redoing_keeps_the_byte_count_honest ... ok
[INFO] [stdout] test editor::tests::undo_hands_back_the_step_and_redo_hands_it_back_again ... ok
[INFO] [stdout] test engine::tests::test_engine_advance_emits_row ... ok
[INFO] [stdout] test engine::tests::test_engine_arpeggio ... ok
[INFO] [stdout] test engine::tests::test_engine_generation_wrap ... ok
[INFO] [stdout] test core::tests::the_nearest_instrument_above_wins ... ok
[INFO] [stdout] test engine::tests::test_engine_muted_channel_no_events ... ok
[INFO] [stdout] test engine::tests::test_engine_new ... ok
[INFO] [stdout] test engine::tests::test_engine_no_wrap_finishes ... ok
[INFO] [stdout] test core::tests::the_track_default_takes_priority_where_one_is_set ... ok
[INFO] [stdout] test engine::tests::test_engine_note_delay ... ok
[INFO] [stdout] test core::tests::wall_clock_playback_still_advances_without_an_audio_device ... ok
[INFO] [stdout] test engine::tests::test_engine_note_on_off ... ok
[INFO] [stdout] test engine::tests::test_engine_position_jump ... ok
[INFO] [stdout] test engine::tests::test_engine_midi_cc ... ok
[INFO] [stdout] test engine::tests::test_engine_seconds_per_tick_swing ... ok
[INFO] [stdout] test engine::tests::test_engine_set_speed_tempo ... ok
[INFO] [stdout] test engine::tests::test_engine_volume_slide ... ok
[INFO] [stdout] test engine::tests::test_swing_follows_the_sounding_row_not_the_write_pointer ... ok
[INFO] [stdout] test error::tests::errors_name_what_failed_and_where ... ok
[INFO] [stdout] test error::tests::slot_errors_are_distinguishable_without_parsing_prose ... ok
[INFO] [stdout] test error::tests::the_source_chain_is_preserved ... ok
[INFO] [stdout] test fs::tests::atomic_save_does_not_write_through_a_symlink_at_the_destination ... ok
[INFO] [stdout] test fs::tests::atomic_save_refuses_a_pre_created_temp_path ... ok
[INFO] [stdout] test audio::synth::tests::test_all_patches_produce_audio ... ok
[INFO] [stdout] test fs::tests::temp_names_do_not_repeat ... ok
[INFO] [stdout] test fs::tests::atomic_save_writes_the_file_and_leaves_no_temp_behind ... ok
[INFO] [stdout] test keymap::tests::each_row_covers_a_chromatic_octave_in_order ... ok
[INFO] [stdout] test audio::synth::tests::test_full_pipeline ... ok
[INFO] [stdout] test keymap::tests::no_key_appears_in_both_rows ... ok
[INFO] [stdout] test engine::tests::test_engine_order_repeats ... ok
[INFO] [stdout] test engine::tests::test_engine_pattern_break ... ok
[INFO] [stdout] test keymap::tests::entry_above_the_top_octave_is_refused ... ok
[INFO] [stdout] test keymap::tests::an_absurd_current_octave_does_not_overflow ... ok
[INFO] [stdout] test engine::tests::test_engine_program_change ... ok
[INFO] [stdout] test engine::tests::test_engine_portamento_up ... ok
[INFO] [stdout] test keymap::tests::octave_offsets_are_applied ... ok
[INFO] [stdout] test link::tests::test_link_capture_returns_state ... ok
[INFO] [stdout] test link::tests::test_link_set_tempo ... ok
[INFO] [stderr] ALSA lib seq_hw.c:540:(snd_seq_hw_open) [error.sequencer] open /dev/snd/seq failed: No such file or directory
[INFO] [stdout] test link::tests::test_link_engine_new ... ok
[INFO] [stdout] test midi::tests::test_channel_note_off ... ok
[INFO] [stdout] test midi::tests::test_list_ports ... ok
[INFO] [stdout] test midi::tests::test_midi_clock_messages ... ok
[INFO] [stdout] test midi::tests::test_midi_engine_new ... ok
[INFO] [stdout] test midi::tests::test_midi_input_engine_new ... ok
[INFO] [stdout] test midi::tests::test_note_on_off_without_connection ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_cc ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_channel_pressure ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_clock ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_empty_message ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_note_off ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_note_on ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_note_on_vel0_is_off ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_pitch_bend ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_poly_pressure ... ok
[INFO] [stdout] test keymap::tests::unmapped_keys_return_none ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_start_stop_continue ... ok
[INFO] [stdout] test midi::tests::test_program_change_without_connection ... ok
[INFO] [stdout] test midi::tests::test_send_cc_without_connection ... ok
[INFO] [stdout] test midi::tests::test_active_note_tracking ... ok
[INFO] [stdout] test link::tests::test_poll_tempo_after_set ... ok
[INFO] [stdout] test midi::tests::test_parse_midi_program_change ... ok
[INFO] [stdout] test link::tests::test_poll_tempo_no_change ... ok
[INFO] [stdout] test link::tests::test_link_play_stop ... ok
[INFO] [stdout] test midi_file::tests::import_leaves_an_ordinary_file_untouched ... ok
[INFO] [stdout] test midi_file::tests::test_bpm_to_microseconds ... ok
[INFO] [stdout] test midi_file::tests::test_export_portamento_produces_pitch_bend ... ok
[INFO] [stdout] test midi_file::tests::test_export_starts_with_mthd ... ok
[INFO] [stdout] test midi_file::tests::test_export_effects_larger_than_plain ... ok
[INFO] [stdout] test midi_file::tests::test_export_vibrato_produces_pitch_bend ... ok
[INFO] [stdout] test midi_file::tests::test_export_volume_slide_produces_cc7 ... ok
[INFO] [stdout] test midi_file::tests::test_export_tempo_changes_in_midi ... ok
[INFO] [stdout] test midi_file::tests::test_fractional_bpm_preserved_in_engine ... ok
[INFO] [stdout] test link::tests::test_link_enable_disable ... ok
[INFO] [stdout] test midi_file::tests::test_export_import_roundtrip ... ok
[INFO] [stdout] test midi_file::tests::test_import_invalid_header_returns_error ... ok
[INFO] [stdout] test midi_file::tests::test_import_empty_file_returns_error ... ok
[INFO] [stdout] test midi_file::tests::test_variable_length_known_encodings ... ok
[INFO] [stdout] test midi_file::tests::test_import_preserves_tempo_automation ... ok
[INFO] [stdout] test midi_file::tests::test_variable_length_roundtrip ... ok
[INFO] [stdout] test midi_file::tests::test_ticks_per_row_calculation ... ok
[INFO] [stdout] test midi_file::tests::import_caps_a_file_with_a_tiny_division ... ok
[INFO] [stdout] test midi_file::tests::import_caps_a_song_that_spans_too_many_patterns ... ok
[INFO] [stdout] test midi_file::tests::import_does_not_overflow_on_accumulated_delta_times ... ok
[INFO] [stdout] test sample::playback::tests::test_continue_leaves_the_channel_polyphonic ... ok
[INFO] [stdout] test sample::playback::tests::test_cut_replaces_the_channel_voice ... ok
[INFO] [stdout] test sample::playback::tests::test_envelope_fade_on_note_off ... ok
[INFO] [stdout] test sample::playback::tests::test_inaudible_voice_is_dropped_not_faded ... ok
[INFO] [stdout] test sample::playback::tests::test_loop_wraps_when_rate_exceeds_loop_length ... ok
[INFO] [stdout] test sample::playback::tests::test_note_off ... ok
[INFO] [stdout] test sample::playback::tests::test_note_off_all ... ok
[INFO] [stdout] test sample::playback::tests::test_note_off_channel ... ok
[INFO] [stdout] test sample::playback::tests::test_note_on_creates_voice ... ok
[INFO] [stdout] test sample::playback::tests::test_note_on_pitch_shift ... ok
[INFO] [stdout] test sample::playback::tests::test_render_loops ... ok
[INFO] [stdout] test sample::playback::tests::test_render_produces_audio ... ok
[INFO] [stdout] test sample::playback::tests::test_render_stops_at_end ... ok
[INFO] [stdout] test sample::playback::tests::test_slice_end_fades_out ... ok
[INFO] [stdout] test sample::playback::tests::test_slice_loop_stays_inside_the_slice ... ok
[INFO] [stdout] test sample::playback::tests::test_voice_on_missing_channel_is_dropped ... ok
[INFO] [stdout] test sample::playback::tests::test_voice_steal_fades_rather_than_cuts ... ok
[INFO] [stdout] test sample::tests::test_detect_transients_empty_range_returns_its_start ... ok
[INFO] [stdout] test sample::tests::test_detect_transients_finds_hits_below_the_loudest ... ok
[INFO] [stdout] test sample::tests::test_detect_transients_range_beyond_the_buffer ... ok
[INFO] [stdout] test sample::tests::test_detect_transients_sensitivity ... ok
[INFO] [stdout] test sample::tests::test_detect_transients_silent ... ok
[INFO] [stdout] test sample::tests::test_detect_transients_with_onset ... ok
[INFO] [stdout] test sample::tests::test_extended_to_f64 ... ok
[INFO] [stdout] test sample::tests::test_load_directory_clamps_out_of_range_loop_points ... ok
[INFO] [stdout] test sample::tests::test_load_directory_deterministic_order ... ok
[INFO] [stdout] test sample::tests::test_load_directory_empty ... ok
[INFO] [stdout] test sample::tests::test_load_directory_keeps_a_whole_file_loop ... ok
[INFO] [stdout] test sample::tests::test_load_directory_keeps_loop_points_that_fit ... ok
[INFO] [stdout] test sample::tests::test_load_directory_nonexistent ... ok
[INFO] [stdout] test sample::tests::test_load_directory_with_wav ... ok
[INFO] [stdout] test sample::tests::test_load_nonexistent_wav ... ok
[INFO] [stdout] test sample::tests::test_load_unsupported_format ... ok
[INFO] [stdout] test sample::tests::test_loop_points_clamped_to_the_slice ... ok
[INFO] [stdout] test sample::tests::test_loop_points_inside_the_slice_are_kept ... ok
[INFO] [stdout] test sample::tests::test_loop_points_outside_the_slice_are_pulled_in ... ok
[INFO] [stdout] test sample::tests::test_re_slicing_from_source_does_not_stack_name_suffixes ... ok
[INFO] [stdout] test sample::tests::test_sample_bank_new ... ok
[INFO] [stdout] test sample::tests::test_sample_bank_slot_out_of_range ... ok
[INFO] [stdout] test sample::tests::test_sample_dir_meta_default ... ok
[INFO] [stdout] test sample::tests::test_sample_dir_meta_deserialize ... ok
[INFO] [stdout] test sample::tests::test_sample_end_default ... ok
[INFO] [stdout] test sample::tests::test_sample_frame_at_out_of_bounds ... ok
[INFO] [stdout] test sample::tests::test_sample_trimmed ... ok
[INFO] [stdout] test sample::tests::test_slice_at_points ... ok
[INFO] [stdout] test sample::tests::test_slice_at_points_empty ... ok
[INFO] [stdout] test sample::tests::test_slice_at_points_single ... ok
[INFO] [stdout] test sample::tests::test_slice_bounds ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_basic ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_last_gets_remainder ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_one ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_preserves_metadata ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_source_ignores_the_span ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_span_stays_inside_it ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_with_trim ... ok
[INFO] [stdout] test sample::tests::test_slice_equal_zero ... ok
[INFO] [stdout] test sample::tests::test_strip_slice_suffix ... ok
[INFO] [stdout] test sample::tests::test_subdividing_keeps_the_parent_in_the_name ... ok
[INFO] [stdout] test sample::tests::test_to_stereo_frames_mono ... ok
[INFO] [stdout] test sample::tests::test_to_stereo_frames_stereo ... ok
[INFO] [stdout] test tracker::pattern::tests::test_cell_default_is_empty ... ok
[INFO] [stdout] test tracker::pattern::tests::test_note_display ... ok
[INFO] [stdout] test tracker::pattern::tests::test_note_to_midi ... ok
[INFO] [stdout] test tracker::pattern::tests::test_note_transposed ... ok
[INFO] [stdout] test tracker::pattern::tests::test_note_value_roundtrip ... ok
[INFO] [stdout] test tracker::pattern::tests::test_pattern_delete_row ... ok
[INFO] [stdout] test tracker::pattern::tests::test_pattern_insert_row ... ok
[INFO] [stdout] test tracker::pattern::tests::test_pattern_new ... ok
[INFO] [stdout] test tracker::pattern::tests::test_pattern_resize_rows ... ok
[INFO] [stdout] test tracker::pattern::tests::test_pattern_set_and_get ... ok
[INFO] [stdout] test tracker::song::tests::a_bare_song_file_still_loads_through_songfile ... ok
[INFO] [stdout] test tracker::song::tests::test_add_order_entry ... ok
[INFO] [stdout] test tracker::song::tests::test_add_pattern ... ok
[INFO] [stdout] test tracker::song::tests::test_cell_access_is_bounds_safe ... ok
[INFO] [stdout] test tracker::song::tests::test_clone_order_entry_copies_cells_into_a_new_pattern ... ok
[INFO] [stdout] test tracker::song::tests::test_pattern_reuse_survives_a_save_load_cycle ... ok
[INFO] [stdout] test tracker::song::tests::test_remove_order_entry_keeps_pattern_for_other_users ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_clamps_a_channel_count_past_the_maximum ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_clamps_a_row_count_past_the_maximum ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_conforms_ragged_pattern_data ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_drops_dangling_order_entries ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_drops_out_of_range_tempo_points ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_leaves_a_song_at_the_limits_alone ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_rebuilds_a_degenerate_song ... ok
[INFO] [stdout] test tracker::song::tests::test_repair_survives_an_absurd_declared_size ... ok
[INFO] [stdout] test tracker::song::tests::test_rows_at_never_returns_zero ... ok
[INFO] [stdout] test tracker::song::tests::test_save_load_roundtrip ... ok
[INFO] [stdout] test tracker::song::tests::test_seconds_per_row ... ok
[INFO] [stdout] test tracker::song::tests::test_song_new ... ok
[INFO] [stdout] test tracker::song::tests::test_songfile_backwards_compat ... ok
[INFO] [stdout] test tracker::song::tests::test_songfile_roundtrip_with_instruments ... ok
[INFO] [stdout] test types::tests::a_saved_path_round_trips ... ok
[INFO] [stdout] test types::tests::absolute_paths_are_kept_as_written ... ok
[INFO] [stdout] test types::tests::an_awkward_title_still_gives_a_usable_file_name ... ok
[INFO] [stdout] test types::tests::an_unsaved_song_autosaves_outside_the_working_directory ... ok
[INFO] [stdout] test types::tests::paths_that_name_nothing_are_errors ... ok
[INFO] [stdout] test types::tests::plain_relative_paths_resolve_under_the_base ... ok
[INFO] [stdout] test types::tests::traversal_is_rejected_rather_than_stripped ... ok
[INFO] [stdout] test types::tests::two_unsaved_songs_do_not_share_an_autosave_file ... ok
[INFO] [stdout] test sample::export::tests::test_render_with_synth_note ... ok
[INFO] [stdout] test sample::export::tests::test_render_to_flac ... ok
[INFO] [stdout] test editor::tests::a_larger_song_gets_fewer_steps_for_the_same_budget ... ok
[INFO] [stdout] test sample::export::tests::test_render_with_sample ... ok
[INFO] [stdout] test sample::export::tests::test_render_volume_slide ... ok
[INFO] [stdout] test sample::export::tests::test_render_portamento_changes_pitch ... ok
[INFO] [stdout] test sample::export::tests::test_render_empty_song ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 315 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 4.74s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/hostile_input.rs (/opt/rustwide/target/debug/build/rtrack-core/b479d12153126b8d/out/hostile_input-b479d12153126b8d)
[INFO] [stdout] 
[INFO] [stdout] running 11 tests
[INFO] [stdout] test aiff_chunk_claiming_more_than_the_whole_file_is_rejected ... ok
[INFO] [stdout] test aiff_comm_chunk_shorter_than_its_own_fields_is_rejected ... ok
[INFO] [stdout] test aiff_degenerate_headers_are_rejected ... ok
[INFO] [stdout] test aiff_frames_times_channels_is_not_an_allocation_size ... ok
[INFO] [stdout] test aiff_ssnd_chunk_smaller_than_its_header_is_rejected ... ok
[INFO] [stdout] test wav_headers_that_lie_are_rejected ... ok
[INFO] [stdout] test every_truncation_of_a_valid_midi_file_is_survivable ... ok
[INFO] [stdout] test single_byte_corruption_of_a_midi_file_is_survivable ... ok
[INFO] [stdout] test every_truncation_of_a_valid_aiff_is_survivable ... ok
[INFO] [stdout] test single_byte_corruption_of_an_aiff_is_survivable ... ok
[INFO] [stderr]      Running tests/note_entry.rs (/opt/rustwide/target/debug/build/rtrack-core/fa1f75b6ddb33f68/out/note_entry-fa1f75b6ddb33f68)
[INFO] [stdout] test every_truncation_of_a_valid_song_file_is_survivable ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 11 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.28s
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] running 4 tests
[INFO] [stdout] test a_synth_preview_is_still_stopped_by_the_timeout ... ok
[INFO] [stdout] test a_looping_sample_preview_is_still_stopped_by_the_timeout ... ok
[INFO] [stdout] test a_one_shot_sample_preview_is_not_cut_off_by_the_timeout ... FAILED
[INFO] [stdout] test every_row_of_the_sliced_amen_example_previews_a_sample ... FAILED
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout] 
[INFO] [stdout] ---- a_one_shot_sample_preview_is_not_cut_off_by_the_timeout stdout ----
[INFO] [stdout] 
[INFO] [stdout] thread 'a_one_shot_sample_preview_is_not_cut_off_by_the_timeout' (2858) panicked at tests/note_entry.rs:59:27:
[INFO] [stdout] called `Result::unwrap()` on an `Err` value: File { path: "/opt/rustwide/examples/sliced-amen.rtrk", source: Failed to read /opt/rustwide/examples/sliced-amen.rtrk
[INFO] [stdout] 
[INFO] [stdout] Caused by:
[INFO] [stdout]     No such file or directory (os error 2)
[INFO] [stdout] 
[INFO] [stdout] Stack backtrace:
[INFO] [stdout]    0: <core::io::error::Error as anyhow::context::ext::StdError>::ext_context::<alloc::string::String>
[INFO] [stdout]              at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.104/src/backtrace.rs:10:14
[INFO] [stdout]    1: <core::result::Result<alloc::string::String, core::io::error::Error> as anyhow::Context<alloc::string::String, core::io::error::Error>>::with_context::<alloc::string::String, <rtrack_core::tracker::song::SongFile>::load::{closure#0}>
[INFO] [stdout]              at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.104/src/context.rs:65:37
[INFO] [stdout]    2: <rtrack_core::tracker::song::SongFile>::load
[INFO] [stdout]              at ./src/tracker/song.rs:175:14
[INFO] [stdout]    3: <rtrack_core::core::TrackerCore>::load_file
[INFO] [stdout]              at ./src/core.rs:1812:15
[INFO] [stdout]    4: note_entry::a_one_shot_sample_preview_is_not_cut_off_by_the_timeout
[INFO] [stdout]              at ./tests/note_entry.rs:59:10
[INFO] [stdout]    5: note_entry::a_one_shot_sample_preview_is_not_cut_off_by_the_timeout::{closure#0}
[INFO] [stdout]              at ./tests/note_entry.rs:50:61
[INFO] [stdout]    6: <note_entry::a_one_shot_sample_preview_is_not_cut_off_by_the_timeout::{closure#0} as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]    7: <fn() -> core::result::Result<(), alloc::string::String> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]    8: test::__rust_begin_short_backtrace::<core::result::Result<(), alloc::string::String>, fn() -> core::result::Result<(), alloc::string::String>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:701:18
[INFO] [stdout]    9: test::run_test_in_process::{closure#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:74
[INFO] [stdout]   10: <core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   11: std::panicking::catch_unwind::do_call::<core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}>, core::result::Result<(), alloc::string::String>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   12: std::panicking::catch_unwind::<core::result::Result<(), alloc::string::String>, core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   13: std::panic::catch_unwind::<core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}>, core::result::Result<(), alloc::string::String>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   14: test::run_test_in_process
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:27
[INFO] [stdout]   15: test::run_test::{closure#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:645:43
[INFO] [stdout]   16: test::run_test::{closure#1}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:675:41
[INFO] [stdout]   17: std::sys::backtrace::__rust_begin_short_backtrace::<test::run_test::{closure#1}, ()>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:166:18
[INFO] [stdout]   18: std::thread::lifecycle::spawn_unchecked::<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:70:13
[INFO] [stdout]   19: <core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   20: std::panicking::catch_unwind::do_call::<core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   21: std::panicking::catch_unwind::<(), core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   22: std::panic::catch_unwind::<core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   23: std::thread::lifecycle::spawn_unchecked::<test::run_test::{closure#1}, ()>::{closure#1}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:68:26
[INFO] [stdout]   24: <std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1} as core::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   25: <alloc::boxed::Box<dyn core::ops::function::FnOnce<(), Output = ()> + core::marker::Send> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2314:9
[INFO] [stdout]   26: <std::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/thread/unix.rs:127:17
[INFO] [stdout]   27: <unknown>
[INFO] [stdout]   28: clone }
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x587837e911d1 - std[617be2ca0a6fd877]::backtrace_rs::backtrace::libunwind::trace
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/../../backtrace/src/backtrace/libunwind.rs:117:9
[INFO] [stdout]    1:     0x587837e911d1 - std[617be2ca0a6fd877]::backtrace_rs::backtrace::trace_unsynchronized::<std[617be2ca0a6fd877]::sys::backtrace::_print_fmt::{closure#1}>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/../../backtrace/src/backtrace/mod.rs:66:14
[INFO] [stdout]    2:     0x587837e911d1 - std[617be2ca0a6fd877]::sys::backtrace::_print_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:74:9
[INFO] [stdout]    3:     0x587837e911d1 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:44:26
[INFO] [stdout]    4:     0x587837ea6c7a - <core[a373ad73a504971]::fmt::rt::Argument>::fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/fmt/rt.rs:152:76
[INFO] [stdout]    5:     0x587837ea6c7a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    6:     0x587837e9598c - core[a373ad73a504971]::io::write::default_write_fmt::<alloc[2e1b2a31b91974c5]::vec::Vec<u8>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/io/write.rs:402:11
[INFO] [stdout]    7:     0x587837e9598c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/io/write.rs:335:13
[INFO] [stdout]    8:     0x587837e6c7a6 - <std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:47:9
[INFO] [stdout]    9:     0x587837e6c7a6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:289:27
[INFO] [stdout]   10:     0x587837e894e9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:313:9
[INFO] [stdout]   11:     0x587837c89410 - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn for<'a, 'b> core[a373ad73a504971]::ops::function::Fn<(&'a std[617be2ca0a6fd877]::panic::PanicHookInfo<'b>,), Output = ()> + core[a373ad73a504971]::marker::Sync + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::Fn<(&std[617be2ca0a6fd877]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2328:9
[INFO] [stdout]   12:     0x587837c89410 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:137:21
[INFO] [stdout]   13:     0x587837e896a2 - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn for<'a, 'b> core[a373ad73a504971]::ops::function::Fn<(&'a std[617be2ca0a6fd877]::panic::PanicHookInfo<'b>,), Output = ()> + core[a373ad73a504971]::marker::Sync + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::Fn<(&std[617be2ca0a6fd877]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2328:9
[INFO] [stdout]   14:     0x587837e896a2 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:819:13
[INFO] [stdout]   15:     0x587837e6c852 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:685:13
[INFO] [stdout]   16:     0x587837e64e49 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:182:18
[INFO] [stdout]   17:     0x587837e6d56d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:676:5
[INFO] [stdout]   18:     0x587837ea746c - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panicking.rs:80:14
[INFO] [stdout]   19:     0x587837ea71c2 - core[a373ad73a504971]::result::unwrap_failed
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/result.rs:1870:5
[INFO] [stdout]   20:     0x587837c7b3c4 - <core[a373ad73a504971]::result::Result<rtrack_core[5548f18b1cd5670c]::core::LoadReport, rtrack_core[5548f18b1cd5670c]::error::Error>>::unwrap
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/result.rs:1232:23
[INFO] [stdout]   21:     0x587837c7b3c4 - note_entry[9922cf7eaeb84b99]::a_one_shot_sample_preview_is_not_cut_off_by_the_timeout
[INFO] [stdout]                                at /opt/rustwide/workdir/tests/note_entry.rs:59:27
[INFO] [stdout]   22:     0x587837c7a8b7 - note_entry[9922cf7eaeb84b99]::a_one_shot_sample_preview_is_not_cut_off_by_the_timeout::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/workdir/tests/note_entry.rs:50:61
[INFO] [stdout]   23:     0x587837c7c7c6 - <note_entry[9922cf7eaeb84b99]::a_one_shot_sample_preview_is_not_cut_off_by_the_timeout::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   24:     0x587837c7c85b - <fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   25:     0x587837c7c85b - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:701:18
[INFO] [stdout]   26:     0x587837c89a35 - test[aada8e7e76ba119b]::run_test_in_process::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:74
[INFO] [stdout]   27:     0x587837c89a35 - <core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   28:     0x587837c89a35 - std[617be2ca0a6fd877]::panicking::catch_unwind::do_call::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>, core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   29:     0x587837c89a35 - std[617be2ca0a6fd877]::panicking::catch_unwind::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   30:     0x587837c89a35 - std[617be2ca0a6fd877]::panic::catch_unwind::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>, core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   31:     0x587837c89a35 - test[aada8e7e76ba119b]::run_test_in_process
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:27
[INFO] [stdout]   32:     0x587837c89a35 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:645:43
[INFO] [stdout]   33:     0x587837c83324 - test[aada8e7e76ba119b]::run_test::{closure#1}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:675:41
[INFO] [stdout]   34:     0x587837c83324 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:166:18
[INFO] [stdout]   35:     0x587837c8cac2 - std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:70:13
[INFO] [stdout]   36:     0x587837c8cac2 - <core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   37:     0x587837c8cac2 - std[617be2ca0a6fd877]::panicking::catch_unwind::do_call::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   38:     0x587837c8cac2 - std[617be2ca0a6fd877]::panicking::catch_unwind::<(), core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   39:     0x587837c8cac2 - std[617be2ca0a6fd877]::panic::catch_unwind::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   40:     0x587837c8cac2 - std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:68:26
[INFO] [stdout]   41:     0x587837c8cac2 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   42:     0x587837e906cf - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn core[a373ad73a504971]::ops::function::FnOnce<(), Output = ()> + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2314:9
[INFO] [stdout]   43:     0x587837e906cf - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/thread/unix.rs:127:17
[INFO] [stdout]   44:     0x7d9a408fadfa - <unknown>
[INFO] [stdout]   45:     0x7d9a4098e3d4 - clone
[INFO] [stdout]   46:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- every_row_of_the_sliced_amen_example_previews_a_sample stdout ----
[INFO] [stdout] 
[INFO] [stdout] thread 'every_row_of_the_sliced_amen_example_previews_a_sample' (2862) panicked at tests/note_entry.rs:20:27:
[INFO] [stdout] example failed to load: File { path: "/opt/rustwide/examples/sliced-amen.rtrk", source: Failed to read /opt/rustwide/examples/sliced-amen.rtrk
[INFO] [stdout] 
[INFO] [stdout] Caused by:
[INFO] [stdout]     No such file or directory (os error 2)
[INFO] [stdout] 
[INFO] [stdout] Stack backtrace:
[INFO] [stdout]    0: <core::io::error::Error as anyhow::context::ext::StdError>::ext_context::<alloc::string::String>
[INFO] [stdout]              at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.104/src/backtrace.rs:10:14
[INFO] [stdout]    1: <core::result::Result<alloc::string::String, core::io::error::Error> as anyhow::Context<alloc::string::String, core::io::error::Error>>::with_context::<alloc::string::String, <rtrack_core::tracker::song::SongFile>::load::{closure#0}>
[INFO] [stdout]              at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.104/src/context.rs:65:37
[INFO] [stdout]    2: <rtrack_core::tracker::song::SongFile>::load
[INFO] [stdout]              at ./src/tracker/song.rs:175:14
[INFO] [stdout]    3: <rtrack_core::core::TrackerCore>::load_file
[INFO] [stdout]              at ./src/core.rs:1812:15
[INFO] [stdout]    4: note_entry::every_row_of_the_sliced_amen_example_previews_a_sample
[INFO] [stdout]              at ./tests/note_entry.rs:20:10
[INFO] [stdout]    5: note_entry::every_row_of_the_sliced_amen_example_previews_a_sample::{closure#0}
[INFO] [stdout]              at ./tests/note_entry.rs:13:60
[INFO] [stdout]    6: <note_entry::every_row_of_the_sliced_amen_example_previews_a_sample::{closure#0} as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]    7: <fn() -> core::result::Result<(), alloc::string::String> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]    8: test::__rust_begin_short_backtrace::<core::result::Result<(), alloc::string::String>, fn() -> core::result::Result<(), alloc::string::String>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:701:18
[INFO] [stdout]    9: test::run_test_in_process::{closure#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:74
[INFO] [stdout]   10: <core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   11: std::panicking::catch_unwind::do_call::<core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}>, core::result::Result<(), alloc::string::String>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   12: std::panicking::catch_unwind::<core::result::Result<(), alloc::string::String>, core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   13: std::panic::catch_unwind::<core::panic::unwind_safe::AssertUnwindSafe<test::run_test_in_process::{closure#0}>, core::result::Result<(), alloc::string::String>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   14: test::run_test_in_process
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:27
[INFO] [stdout]   15: test::run_test::{closure#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:645:43
[INFO] [stdout]   16: test::run_test::{closure#1}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:675:41
[INFO] [stdout]   17: std::sys::backtrace::__rust_begin_short_backtrace::<test::run_test::{closure#1}, ()>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:166:18
[INFO] [stdout]   18: std::thread::lifecycle::spawn_unchecked::<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:70:13
[INFO] [stdout]   19: <core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   20: std::panicking::catch_unwind::do_call::<core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   21: std::panicking::catch_unwind::<(), core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   22: std::panic::catch_unwind::<core::panic::unwind_safe::AssertUnwindSafe<std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   23: std::thread::lifecycle::spawn_unchecked::<test::run_test::{closure#1}, ()>::{closure#1}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:68:26
[INFO] [stdout]   24: <std::thread::lifecycle::spawn_unchecked<test::run_test::{closure#1}, ()>::{closure#1} as core::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   25: <alloc::boxed::Box<dyn core::ops::function::FnOnce<(), Output = ()> + core::marker::Send> as core::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2314:9
[INFO] [stdout]   26: <std::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]              at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/thread/unix.rs:127:17
[INFO] [stdout]   27: <unknown>
[INFO] [stdout]   28: clone }
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x587837e911d1 - std[617be2ca0a6fd877]::backtrace_rs::backtrace::libunwind::trace
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/../../backtrace/src/backtrace/libunwind.rs:117:9
[INFO] [stdout]    1:     0x587837e911d1 - std[617be2ca0a6fd877]::backtrace_rs::backtrace::trace_unsynchronized::<std[617be2ca0a6fd877]::sys::backtrace::_print_fmt::{closure#1}>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/../../backtrace/src/backtrace/mod.rs:66:14
[INFO] [stdout]    2:     0x587837e911d1 - std[617be2ca0a6fd877]::sys::backtrace::_print_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:74:9
[INFO] [stdout]    3:     0x587837e911d1 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:44:26
[INFO] [stdout]    4:     0x587837ea6c7a - <core[a373ad73a504971]::fmt::rt::Argument>::fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/fmt/rt.rs:152:76
[INFO] [stdout]    5:     0x587837ea6c7a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    6:     0x587837e9598c - core[a373ad73a504971]::io::write::default_write_fmt::<alloc[2e1b2a31b91974c5]::vec::Vec<u8>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/io/write.rs:402:11
[INFO] [stdout]    7:     0x587837e9598c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/io/write.rs:335:13
[INFO] [stdout]    8:     0x587837e6c7a6 - <std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:47:9
[INFO] [stdout]    9:     0x587837e6c7a6 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:289:27
[INFO] [stdout]   10:     0x587837e894e9 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:313:9
[INFO] [stdout]   11:     0x587837c89410 - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn for<'a, 'b> core[a373ad73a504971]::ops::function::Fn<(&'a std[617be2ca0a6fd877]::panic::PanicHookInfo<'b>,), Output = ()> + core[a373ad73a504971]::marker::Sync + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::Fn<(&std[617be2ca0a6fd877]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2328:9
[INFO] [stdout]   12:     0x587837c89410 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:137:21
[INFO] [stdout]   13:     0x587837e896a2 - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn for<'a, 'b> core[a373ad73a504971]::ops::function::Fn<(&'a std[617be2ca0a6fd877]::panic::PanicHookInfo<'b>,), Output = ()> + core[a373ad73a504971]::marker::Sync + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::Fn<(&std[617be2ca0a6fd877]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2328:9
[INFO] [stdout]   14:     0x587837e896a2 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:819:13
[INFO] [stdout]   15:     0x587837e6c852 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:685:13
[INFO] [stdout]   16:     0x587837e64e49 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:182:18
[INFO] [stdout]   17:     0x587837e6d56d - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:676:5
[INFO] [stdout]   18:     0x587837ea746c - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panicking.rs:80:14
[INFO] [stdout]   19:     0x587837ea71c2 - core[a373ad73a504971]::result::unwrap_failed
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/result.rs:1870:5
[INFO] [stdout]   20:     0x587837c7bbec - <core[a373ad73a504971]::result::Result<rtrack_core[5548f18b1cd5670c]::core::LoadReport, rtrack_core[5548f18b1cd5670c]::error::Error>>::expect
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/result.rs:1184:23
[INFO] [stdout]   21:     0x587837c7ad5e - note_entry[9922cf7eaeb84b99]::every_row_of_the_sliced_amen_example_previews_a_sample
[INFO] [stdout]                                at /opt/rustwide/workdir/tests/note_entry.rs:20:27
[INFO] [stdout]   22:     0x587837c7a887 - note_entry[9922cf7eaeb84b99]::every_row_of_the_sliced_amen_example_previews_a_sample::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/workdir/tests/note_entry.rs:13:60
[INFO] [stdout]   23:     0x587837c7c7a6 - <note_entry[9922cf7eaeb84b99]::every_row_of_the_sliced_amen_example_previews_a_sample::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   24:     0x587837c7c85b - <fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   25:     0x587837c7c85b - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:701:18
[INFO] [stdout]   26:     0x587837c89a35 - test[aada8e7e76ba119b]::run_test_in_process::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:74
[INFO] [stdout]   27:     0x587837c89a35 - <core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   28:     0x587837c89a35 - std[617be2ca0a6fd877]::panicking::catch_unwind::do_call::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>, core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   29:     0x587837c89a35 - std[617be2ca0a6fd877]::panicking::catch_unwind::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   30:     0x587837c89a35 - std[617be2ca0a6fd877]::panic::catch_unwind::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>, core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   31:     0x587837c89a35 - test[aada8e7e76ba119b]::run_test_in_process
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:27
[INFO] [stdout]   32:     0x587837c89a35 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:645:43
[INFO] [stdout]   33:     0x587837c83324 - test[aada8e7e76ba119b]::run_test::{closure#1}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:675:41
[INFO] [stdout]   34:     0x587837c83324 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:166:18
[INFO] [stdout]   35:     0x587837c8cac2 - std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:70:13
[INFO] [stdout]   36:     0x587837c8cac2 - <core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   37:     0x587837c8cac2 - std[617be2ca0a6fd877]::panicking::catch_unwind::do_call::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   38:     0x587837c8cac2 - std[617be2ca0a6fd877]::panicking::catch_unwind::<(), core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   39:     0x587837c8cac2 - std[617be2ca0a6fd877]::panic::catch_unwind::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   40:     0x587837c8cac2 - std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:68:26
[INFO] [stdout]   41:     0x587837c8cac2 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   42:     0x587837e906cf - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn core[a373ad73a504971]::ops::function::FnOnce<(), Output = ()> + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2314:9
[INFO] [stdout]   43:     0x587837e906cf - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/thread/unix.rs:127:17
[INFO] [stdout]   44:     0x7d9a408fadfa - <unknown>
[INFO] [stdout]   45:     0x7d9a4098e3d4 - clone
[INFO] [stdout]   46:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout]     a_one_shot_sample_preview_is_not_cut_off_by_the_timeout
[INFO] [stdout]     every_row_of_the_sliced_amen_example_previews_a_sample
[INFO] [stdout] 
[INFO] [stdout] test result: FAILED. 2 passed; 2 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.14s
[INFO] [stdout] 
[INFO] [stderr] error: test failed, to rerun pass `--test note_entry`
[INFO] running `Command { std: "docker" "inspect" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4", kill_on_drop: false }`
[INFO] [stdout] 199df2076429524b72e2b75d8e56ae1f625031e0130754c4db930032539b3aa4
