[INFO] cloning repository https://github.com/Alastair-smith2/rust_songs
[INFO] running `Command { std: "git" "-c" "credential.helper=" "-c" "credential.helper=/workspace/cargo-home/bin/git-credential-null" "clone" "--bare" "https://github.com/Alastair-smith2/rust_songs" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FAlastair-smith2%2Frust_songs", kill_on_drop: false }`
[INFO] [stderr] Cloning into bare repository '/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FAlastair-smith2%2Frust_songs'...
[INFO] running `Command { std: "git" "rev-parse" "HEAD", kill_on_drop: false }`
[INFO] [stdout] e8383b7416510cdfed348f7b8f5920e8fd3147e5
[INFO] testing Alastair-smith2/rust_songs against beta-2023-04-20 for beta-1.70-1
[INFO] running `Command { std: "git" "clone" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FAlastair-smith2%2Frust_songs" "/workspace/builds/worker-1-tc2/source", kill_on_drop: false }`
[INFO] [stderr] Cloning into '/workspace/builds/worker-1-tc2/source'...
[INFO] [stderr] done.
[INFO] validating manifest of git repo https://github.com/Alastair-smith2/rust_songs on toolchain beta-2023-04-20
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+beta-2023-04-20" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] started tweaking git repo https://github.com/Alastair-smith2/rust_songs
[INFO] finished tweaking git repo https://github.com/Alastair-smith2/rust_songs
[INFO] tweaked toml for git repo https://github.com/Alastair-smith2/rust_songs written to /workspace/builds/worker-1-tc2/source/Cargo.toml
[INFO] crate git repo https://github.com/Alastair-smith2/rust_songs 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" "+beta-2023-04-20" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] [stderr]  Downloading crates ...
[INFO] [stderr]   Downloaded assert_cmd v2.0.4
[INFO] [stderr]   Downloaded clap_lex v0.1.1
[INFO] [stderr]   Downloaded clap v3.1.9
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/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:5ff2268d62e97bff2cde7d5815dd6ed5b47097566f13b8d0ca110b04b60e07ed" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2023-04-20" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] 060daad451c5665624dbae1a6f5c4ac7a32ef985bdc0e6c2bf1b66bd80875706
[INFO] running `Command { std: "docker" "start" "-a" "060daad451c5665624dbae1a6f5c4ac7a32ef985bdc0e6c2bf1b66bd80875706", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "060daad451c5665624dbae1a6f5c4ac7a32ef985bdc0e6c2bf1b66bd80875706", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "060daad451c5665624dbae1a6f5c4ac7a32ef985bdc0e6c2bf1b66bd80875706", kill_on_drop: false }`
[INFO] [stdout] 060daad451c5665624dbae1a6f5c4ac7a32ef985bdc0e6c2bf1b66bd80875706
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/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=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-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:5ff2268d62e97bff2cde7d5815dd6ed5b47097566f13b8d0ca110b04b60e07ed" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2023-04-20" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] 0d7c70dc3e6eee7c12e22c1d338432cd8878a92bdb3ff1a677f213cce7c62f12
[INFO] running `Command { std: "docker" "start" "-a" "0d7c70dc3e6eee7c12e22c1d338432cd8878a92bdb3ff1a677f213cce7c62f12", kill_on_drop: false }`
[INFO] [stderr]    Compiling proc-macro2 v1.0.37
[INFO] [stderr]    Compiling syn v1.0.91
[INFO] [stderr]    Compiling libc v0.2.123
[INFO] [stderr]    Compiling serde_derive v1.0.136
[INFO] [stderr]    Compiling proc-macro-error-attr v1.0.4
[INFO] [stderr]    Compiling num-traits v0.2.14
[INFO] [stderr]    Compiling tinyvec_macros v0.1.0
[INFO] [stderr]    Compiling num-integer v0.1.44
[INFO] [stderr]    Compiling tinyvec v1.5.1
[INFO] [stderr]    Compiling proc-macro-error v1.0.4
[INFO] [stderr]    Compiling matches v0.1.9
[INFO] [stderr]    Compiling serde v1.0.136
[INFO] [stderr]    Compiling indexmap v1.8.1
[INFO] [stderr]    Compiling unicode-bidi v0.3.7
[INFO] [stderr]    Compiling form_urlencoded v1.0.1
[INFO] [stderr]    Compiling hashbrown v0.11.2
[INFO] [stderr]    Compiling regex-automata v0.1.10
[INFO] [stderr]    Compiling quote v1.0.18
[INFO] [stderr]    Compiling unicode-normalization v0.1.19
[INFO] [stderr]    Compiling time v0.1.44
[INFO] [stderr]    Compiling os_str_bytes v6.0.0
[INFO] [stderr]    Compiling heck v0.4.0
[INFO] [stderr]    Compiling clap_lex v0.1.1
[INFO] [stderr]    Compiling atty v0.2.14
[INFO] [stderr]    Compiling csv-core v0.1.10
[INFO] [stderr]    Compiling ryu v1.0.9
[INFO] [stderr]    Compiling chrono v0.4.19
[INFO] [stderr]    Compiling termcolor v1.1.3
[INFO] [stderr]    Compiling itoa v0.4.8
[INFO] [stderr]    Compiling idna v0.2.3
[INFO] [stderr]    Compiling strsim v0.10.0
[INFO] [stderr]    Compiling textwrap v0.15.0
[INFO] [stderr]    Compiling url v2.2.2
[INFO] [stderr]    Compiling songs v0.1.0 (/opt/rustwide/workdir/songs)
[INFO] [stderr]    Compiling clap_derive v3.1.7
[INFO] [stderr]    Compiling clap v3.1.9
[INFO] [stderr]    Compiling bstr v0.2.17
[INFO] [stderr]    Compiling csv v1.1.6
[INFO] [stderr]    Compiling song-cli v0.1.0 (/opt/rustwide/workdir/song-cli)
[INFO] [stdout] warning: unused variable: `reason`
[INFO] [stdout]   --> song-cli/src/infra/error.rs:24:42
[INFO] [stdout]    |
[INFO] [stdout] 24 |             SongResultError::LookupError(reason) => None,
[INFO] [stdout]    |                                          ^^^^^^ help: if this is intentional, prefix it with an underscore: `_reason`
[INFO] [stdout]    |
[INFO] [stdout]    = note: `#[warn(unused_variables)]` on by default
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] warning: 1 warning emitted
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 9.76s
[INFO] running `Command { std: "docker" "inspect" "0d7c70dc3e6eee7c12e22c1d338432cd8878a92bdb3ff1a677f213cce7c62f12", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "0d7c70dc3e6eee7c12e22c1d338432cd8878a92bdb3ff1a677f213cce7c62f12", kill_on_drop: false }`
[INFO] [stdout] 0d7c70dc3e6eee7c12e22c1d338432cd8878a92bdb3ff1a677f213cce7c62f12
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/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=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-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:5ff2268d62e97bff2cde7d5815dd6ed5b47097566f13b8d0ca110b04b60e07ed" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2023-04-20" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] 427502b739500f9e821340d2135b7229fcb337ac5c96223cec655bb9f5b27de8
[INFO] running `Command { std: "docker" "start" "-a" "427502b739500f9e821340d2135b7229fcb337ac5c96223cec655bb9f5b27de8", kill_on_drop: false }`
[INFO] [stderr]    Compiling aho-corasick v0.7.18
[INFO] [stderr]    Compiling regex-syntax v0.6.25
[INFO] [stderr]    Compiling either v1.6.1
[INFO] [stderr]    Compiling predicates-core v1.0.3
[INFO] [stderr]    Compiling doc-comment v0.3.3
[INFO] [stderr]    Compiling float-cmp v0.9.0
[INFO] [stderr]    Compiling normalize-line-endings v0.3.0
[INFO] [stderr]    Compiling termtree v0.2.4
[INFO] [stderr]    Compiling difflib v0.4.0
[INFO] [stderr]    Compiling itertools v0.10.3
[INFO] [stderr]    Compiling predicates-tree v1.0.5
[INFO] [stderr]    Compiling wait-timeout v0.2.0
[INFO] [stdout] warning: unused variable: `reason`
[INFO] [stdout]   --> song-cli/src/infra/error.rs:24:42
[INFO] [stdout]    |
[INFO] [stdout] 24 |             SongResultError::LookupError(reason) => None,
[INFO] [stdout]    |                                          ^^^^^^ help: if this is intentional, prefix it with an underscore: `_reason`
[INFO] [stdout]    |
[INFO] [stdout]    = note: `#[warn(unused_variables)]` on by default
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] warning: 1 warning emitted
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stderr]    Compiling songs v0.1.0 (/opt/rustwide/workdir/songs)
[INFO] [stderr]    Compiling regex v1.5.5
[INFO] [stderr]    Compiling predicates v2.1.1
[INFO] [stderr]    Compiling assert_cmd v2.0.4
[INFO] [stderr]    Compiling song-cli v0.1.0 (/opt/rustwide/workdir/song-cli)
[INFO] [stdout] warning: unused variable: `reason`
[INFO] [stdout]   --> song-cli/src/infra/error.rs:24:42
[INFO] [stdout]    |
[INFO] [stdout] 24 |             SongResultError::LookupError(reason) => None,
[INFO] [stdout]    |                                          ^^^^^^ help: if this is intentional, prefix it with an underscore: `_reason`
[INFO] [stdout]    |
[INFO] [stdout]    = note: `#[warn(unused_variables)]` on by default
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] warning: 1 warning emitted
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 3.61s
[INFO] running `Command { std: "docker" "inspect" "427502b739500f9e821340d2135b7229fcb337ac5c96223cec655bb9f5b27de8", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "427502b739500f9e821340d2135b7229fcb337ac5c96223cec655bb9f5b27de8", kill_on_drop: false }`
[INFO] [stdout] 427502b739500f9e821340d2135b7229fcb337ac5c96223cec655bb9f5b27de8
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/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=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-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:5ff2268d62e97bff2cde7d5815dd6ed5b47097566f13b8d0ca110b04b60e07ed" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2023-04-20" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] 3e53b5620044c119830f169a3efe870bbca38513cdb37ccbc9fd822998af55eb
[INFO] running `Command { std: "docker" "start" "-a" "3e53b5620044c119830f169a3efe870bbca38513cdb37ccbc9fd822998af55eb", kill_on_drop: false }`
[INFO] [stderr] warning: unused variable: `reason`
[INFO] [stderr]   --> song-cli/src/infra/error.rs:24:42
[INFO] [stderr]    |
[INFO] [stderr] 24 |             SongResultError::LookupError(reason) => None,
[INFO] [stderr]    |                                          ^^^^^^ help: if this is intentional, prefix it with an underscore: `_reason`
[INFO] [stderr]    |
[INFO] [stderr]    = note: `#[warn(unused_variables)]` on by default
[INFO] [stderr] 
[INFO] [stderr] warning: `song-cli` (bin "song-cli") generated 1 warning (run `cargo fix --bin "song-cli"` to apply 1 suggestion)
[INFO] [stderr] warning: `song-cli` (bin "song-cli" test) generated 1 warning (1 duplicate)
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 0.03s
[INFO] [stderr]      Running unittests src/main.rs (/opt/rustwide/target/debug/deps/song_cli-e7d158ef57188da0)
[INFO] [stdout] 
[INFO] [stdout] running 0 tests
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/cli.rs (/opt/rustwide/target/debug/deps/cli-39f6d2d41b978bec)
[INFO] [stdout] 
[INFO] [stdout] running 2 tests
[INFO] [stdout] test song_was_played ... FAILED
[INFO] [stdout] test song_was_created ... FAILED
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout] 
[INFO] [stdout] ---- song_was_played stdout ----
[INFO] [stdout] thread 'song_was_played' panicked at 'Unexpected stdout, failed var.contains(The song "Edm3" was created)
[INFO] [stdout] ├── var: The args Cli { command: CreateSong(CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }), csv: "test.csv" }
[INFO] [stdout] │   The song CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }
[INFO] [stdout] └── var as str: The args Cli { command: CreateSong(CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }), csv: "test.csv" }
[INFO] [stdout]     The song CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }
[INFO] [stdout] 
[INFO] [stdout] command=`"/opt/rustwide/target/debug/song-cli" "--csv" "test.csv" "create-song" "-t" "Edm3" "-u" "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s"`
[INFO] [stdout] code=0
[INFO] [stdout] stdout="The args Cli { command: CreateSong(CreateSong { title: \"Edm3\", url: \"https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s\" }), csv: \"test.csv\" }\nThe song CreateSong { title: \"Edm3\", url: \"https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s\" }\n"
[INFO] [stdout] stderr="An error occurred while creating the song \"Read-only file system (os error 30)\"\n"
[INFO] [stdout] ', /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x5575c278410a - std::backtrace_rs::backtrace::libunwind::trace::h2f05d0192276a8f6
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/../../backtrace/src/backtrace/libunwind.rs:93:5
[INFO] [stdout]    1:     0x5575c278410a - std::backtrace_rs::backtrace::trace_unsynchronized::hedc23dff7a1af150
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5
[INFO] [stdout]    2:     0x5575c278410a - std::sys_common::backtrace::_print_fmt::h17541ef7592f3ce2
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:65:5
[INFO] [stdout]    3:     0x5575c278410a - <std::sys_common::backtrace::_print::DisplayBacktrace as core::fmt::Display>::fmt::h20f75df5ab0c0792
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:44:22
[INFO] [stdout]    4:     0x5575c27a8b3f - core::fmt::write::h78109e6f466b3af6
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/fmt/mod.rs:1254:17
[INFO] [stdout]    5:     0x5575c2781135 - std::io::Write::write_fmt::hd24bfb68a1b35a25
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/io/mod.rs:1698:15
[INFO] [stdout]    6:     0x5575c2783ed5 - std::sys_common::backtrace::_print::h8dac57a9f8fbf9a5
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:47:5
[INFO] [stdout]    7:     0x5575c2783ed5 - std::sys_common::backtrace::print::hf9ecbf41d1aa712f
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:34:9
[INFO] [stdout]    8:     0x5575c2785c0e - std::panicking::default_hook::{{closure}}::h04c07acfc84ca028
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:269:22
[INFO] [stdout]    9:     0x5575c2785941 - std::panicking::default_hook::h01f6bb23e1eceb2c
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:285:9
[INFO] [stdout]   10:     0x5575c273662b - <alloc::boxed::Box<F,A> as core::ops::function::Fn<Args>>::call::h87fe9f7b2fd49e4c
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1987:9
[INFO] [stdout]   11:     0x5575c273662b - test::test_main::{{closure}}::he94d679243a7531b
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:134:21
[INFO] [stdout]   12:     0x5575c27862f4 - <alloc::boxed::Box<F,A> as core::ops::function::Fn<Args>>::call::h3f2d6d8b14c4769f
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1987:9
[INFO] [stdout]   13:     0x5575c27862f4 - std::panicking::rust_panic_with_hook::h2bb3722bbaf2f6df
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:695:13
[INFO] [stdout]   14:     0x5575c2786069 - std::panicking::begin_panic_handler::{{closure}}::h91bc7f36a4be011b
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:582:13
[INFO] [stdout]   15:     0x5575c2784576 - std::sys_common::backtrace::__rust_end_short_backtrace::h8b3d3717114f9e59
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:150:18
[INFO] [stdout]   16:     0x5575c2785dc2 - rust_begin_unwind
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:578:5
[INFO] [stdout]   17:     0x5575c26ffc43 - core::panicking::panic_fmt::hfd368e3fbdabea26
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panicking.rs:67:14
[INFO] [stdout]   18:     0x5575c27448bf - core::panicking::panic_display::h62503c2b968720e4
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panicking.rs:150:5
[INFO] [stdout]   19:     0x5575c2741027 - assert_cmd::assert::AssertError::panic::h82b9807565657c41
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-6f17d22bba15001f/assert_cmd-2.0.4/src/assert.rs:1036:9
[INFO] [stdout]   20:     0x5575c27419a7 - core::ops::function::FnOnce::call_once::h19231c7ebb314801
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   21:     0x5575c274268f - core::result::Result<T,E>::unwrap_or_else::h15172fc0f100ee70
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/result.rs:1464:23
[INFO] [stdout]   22:     0x5575c2701619 - assert_cmd::assert::Assert::stdout::h218246f3cc3c1335
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-6f17d22bba15001f/assert_cmd-2.0.4/src/assert.rs:362:9
[INFO] [stdout]   23:     0x5575c2701096 - cli::song_was_played::h1fb81f1f9f1b8e82
[INFO] [stdout]                                at /opt/rustwide/workdir/song-cli/tests/cli.rs:35:5
[INFO] [stdout]   24:     0x5575c2700e57 - cli::song_was_played::{{closure}}::ha1735e0a0f8473d3
[INFO] [stdout]                                at /opt/rustwide/workdir/song-cli/tests/cli.rs:30:25
[INFO] [stdout]   25:     0x5575c27018d5 - core::ops::function::FnOnce::call_once::h0630b86c84afc0e1
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   26:     0x5575c273b4ff - core::ops::function::FnOnce::call_once::ha6a70e79f7481a7e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   27:     0x5575c273b4ff - test::__rust_begin_short_backtrace::hce33033019b61e69
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:655:18
[INFO] [stdout]   28:     0x5575c2708cec - test::run_test::{{closure}}::h858d3528838ae3e5
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:646:30
[INFO] [stdout]   29:     0x5575c2708cec - core::ops::function::FnOnce::call_once{{vtable.shim}}::he8ac2b00f01ae79e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   30:     0x5575c273a5d6 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::h8093d25b522725ef
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1973:9
[INFO] [stdout]   31:     0x5575c273a5d6 - <core::panic::unwind_safe::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::h5c334c204e4a3913
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panic/unwind_safe.rs:271:9
[INFO] [stdout]   32:     0x5575c273a5d6 - std::panicking::try::do_call::ha8b740c7b9478074
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:485:40
[INFO] [stdout]   33:     0x5575c273a5d6 - std::panicking::try::h5d34f63d0e41b64e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:449:19
[INFO] [stdout]   34:     0x5575c273a5d6 - std::panic::catch_unwind::hcfbb511e1aa7fc67
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panic.rs:140:14
[INFO] [stdout]   35:     0x5575c273a5d6 - test::run_test_in_process::h9abda90f802eaf21
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:678:27
[INFO] [stdout]   36:     0x5575c273a5d6 - test::run_test::run_test_inner::{{closure}}::h0f058de91f6c6edf
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:572:39
[INFO] [stdout]   37:     0x5575c27034f5 - test::run_test::run_test_inner::{{closure}}::h5ca48a4c59c6c1fb
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:599:37
[INFO] [stdout]   38:     0x5575c27034f5 - std::sys_common::backtrace::__rust_begin_short_backtrace::h32bd51e1495d4a33
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:134:18
[INFO] [stdout]   39:     0x5575c2708a31 - std::thread::Builder::spawn_unchecked_::{{closure}}::{{closure}}::hc086fae9b128b2db
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/thread/mod.rs:526:17
[INFO] [stdout]   40:     0x5575c2708a31 - <core::panic::unwind_safe::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::hb66571888d270d43
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panic/unwind_safe.rs:271:9
[INFO] [stdout]   41:     0x5575c2708a31 - std::panicking::try::do_call::h4fa2ef4f6e51fecf
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:485:40
[INFO] [stdout]   42:     0x5575c2708a31 - std::panicking::try::h1e9e22b8584489b5
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:449:19
[INFO] [stdout]   43:     0x5575c2708a31 - std::panic::catch_unwind::h44698a3de0e0769e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panic.rs:140:14
[INFO] [stdout]   44:     0x5575c2708a31 - std::thread::Builder::spawn_unchecked_::{{closure}}::h50153abde3fe239e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/thread/mod.rs:525:30
[INFO] [stdout]   45:     0x5575c2708a31 - core::ops::function::FnOnce::call_once{{vtable.shim}}::hbe5bbf6f38394364
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   46:     0x5575c278afa5 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::h0d83cb2920a49046
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1973:9
[INFO] [stdout]   47:     0x5575c278afa5 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::hbe0a008aa7d9ef59
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1973:9
[INFO] [stdout]   48:     0x5575c278afa5 - std::sys::unix::thread::Thread::new::thread_start::h3a466996bdf6b1f9
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys/unix/thread.rs:108:17
[INFO] [stdout]   49:     0x7f0ae1e49b43 - <unknown>
[INFO] [stdout]   50:     0x7f0ae1edabb4 - __clone
[INFO] [stdout]   51:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- song_was_created stdout ----
[INFO] [stdout] thread 'song_was_created' panicked at 'Unexpected stdout, failed var.contains(The song "Edm3" was created)
[INFO] [stdout] ├── var: The args Cli { command: CreateSong(CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }), csv: "test.csv" }
[INFO] [stdout] │   The song CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }
[INFO] [stdout] └── var as str: The args Cli { command: CreateSong(CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }), csv: "test.csv" }
[INFO] [stdout]     The song CreateSong { title: "Edm3", url: "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s" }
[INFO] [stdout] 
[INFO] [stdout] command=`"/opt/rustwide/target/debug/song-cli" "--csv" "test.csv" "create-song" "-t" "Edm3" "-u" "https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s"`
[INFO] [stdout] code=0
[INFO] [stdout] stdout="The args Cli { command: CreateSong(CreateSong { title: \"Edm3\", url: \"https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s\" }), csv: \"test.csv\" }\nThe song CreateSong { title: \"Edm3\", url: \"https://www.youtube.com/watch?v=m9c9WkmVfXY&t=8565s\" }\n"
[INFO] [stdout] stderr="An error occurred while creating the song \"Read-only file system (os error 30)\"\n"
[INFO] [stdout] ', /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x5575c278410a - std::backtrace_rs::backtrace::libunwind::trace::h2f05d0192276a8f6
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/../../backtrace/src/backtrace/libunwind.rs:93:5
[INFO] [stdout]    1:     0x5575c278410a - std::backtrace_rs::backtrace::trace_unsynchronized::hedc23dff7a1af150
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5
[INFO] [stdout]    2:     0x5575c278410a - std::sys_common::backtrace::_print_fmt::h17541ef7592f3ce2
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:65:5
[INFO] [stdout]    3:     0x5575c278410a - <std::sys_common::backtrace::_print::DisplayBacktrace as core::fmt::Display>::fmt::h20f75df5ab0c0792
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:44:22
[INFO] [stdout]    4:     0x5575c27a8b3f - core::fmt::write::h78109e6f466b3af6
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/fmt/mod.rs:1254:17
[INFO] [stdout]    5:     0x5575c2781135 - std::io::Write::write_fmt::hd24bfb68a1b35a25
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/io/mod.rs:1698:15
[INFO] [stdout]    6:     0x5575c2783ed5 - std::sys_common::backtrace::_print::h8dac57a9f8fbf9a5
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:47:5
[INFO] [stdout]    7:     0x5575c2783ed5 - std::sys_common::backtrace::print::hf9ecbf41d1aa712f
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:34:9
[INFO] [stdout]    8:     0x5575c2785c0e - std::panicking::default_hook::{{closure}}::h04c07acfc84ca028
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:269:22
[INFO] [stdout]    9:     0x5575c2785941 - std::panicking::default_hook::h01f6bb23e1eceb2c
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:285:9
[INFO] [stdout]   10:     0x5575c273662b - <alloc::boxed::Box<F,A> as core::ops::function::Fn<Args>>::call::h87fe9f7b2fd49e4c
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1987:9
[INFO] [stdout]   11:     0x5575c273662b - test::test_main::{{closure}}::he94d679243a7531b
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:134:21
[INFO] [stdout]   12:     0x5575c27862f4 - <alloc::boxed::Box<F,A> as core::ops::function::Fn<Args>>::call::h3f2d6d8b14c4769f
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1987:9
[INFO] [stdout]   13:     0x5575c27862f4 - std::panicking::rust_panic_with_hook::h2bb3722bbaf2f6df
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:695:13
[INFO] [stdout]   14:     0x5575c2786069 - std::panicking::begin_panic_handler::{{closure}}::h91bc7f36a4be011b
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:582:13
[INFO] [stdout]   15:     0x5575c2784576 - std::sys_common::backtrace::__rust_end_short_backtrace::h8b3d3717114f9e59
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:150:18
[INFO] [stdout]   16:     0x5575c2785dc2 - rust_begin_unwind
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:578:5
[INFO] [stdout]   17:     0x5575c26ffc43 - core::panicking::panic_fmt::hfd368e3fbdabea26
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panicking.rs:67:14
[INFO] [stdout]   18:     0x5575c27448bf - core::panicking::panic_display::h62503c2b968720e4
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panicking.rs:150:5
[INFO] [stdout]   19:     0x5575c2741027 - assert_cmd::assert::AssertError::panic::h82b9807565657c41
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-6f17d22bba15001f/assert_cmd-2.0.4/src/assert.rs:1036:9
[INFO] [stdout]   20:     0x5575c27419a7 - core::ops::function::FnOnce::call_once::h19231c7ebb314801
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   21:     0x5575c274268f - core::result::Result<T,E>::unwrap_or_else::h15172fc0f100ee70
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/result.rs:1464:23
[INFO] [stdout]   22:     0x5575c2701619 - assert_cmd::assert::Assert::stdout::h218246f3cc3c1335
[INFO] [stdout]                                at /opt/rustwide/cargo-home/registry/src/index.crates.io-6f17d22bba15001f/assert_cmd-2.0.4/src/assert.rs:362:9
[INFO] [stdout]   23:     0x5575c2700d38 - cli::song_was_created::h32e57945dbbbf76a
[INFO] [stdout]                                at /opt/rustwide/workdir/song-cli/tests/cli.rs:21:5
[INFO] [stdout]   24:     0x5575c2700b37 - cli::song_was_created::{{closure}}::h377c8c9d75f1e40d
[INFO] [stdout]                                at /opt/rustwide/workdir/song-cli/tests/cli.rs:16:26
[INFO] [stdout]   25:     0x5575c2701925 - core::ops::function::FnOnce::call_once::ha96f7cfe2aa23645
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   26:     0x5575c273b4ff - core::ops::function::FnOnce::call_once::ha6a70e79f7481a7e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   27:     0x5575c273b4ff - test::__rust_begin_short_backtrace::hce33033019b61e69
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:655:18
[INFO] [stdout]   28:     0x5575c2708cec - test::run_test::{{closure}}::h858d3528838ae3e5
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:646:30
[INFO] [stdout]   29:     0x5575c2708cec - core::ops::function::FnOnce::call_once{{vtable.shim}}::he8ac2b00f01ae79e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   30:     0x5575c273a5d6 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::h8093d25b522725ef
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1973:9
[INFO] [stdout]   31:     0x5575c273a5d6 - <core::panic::unwind_safe::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::h5c334c204e4a3913
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panic/unwind_safe.rs:271:9
[INFO] [stdout]   32:     0x5575c273a5d6 - std::panicking::try::do_call::ha8b740c7b9478074
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:485:40
[INFO] [stdout]   33:     0x5575c273a5d6 - std::panicking::try::h5d34f63d0e41b64e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:449:19
[INFO] [stdout]   34:     0x5575c273a5d6 - std::panic::catch_unwind::hcfbb511e1aa7fc67
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panic.rs:140:14
[INFO] [stdout]   35:     0x5575c273a5d6 - test::run_test_in_process::h9abda90f802eaf21
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:678:27
[INFO] [stdout]   36:     0x5575c273a5d6 - test::run_test::run_test_inner::{{closure}}::h0f058de91f6c6edf
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:572:39
[INFO] [stdout]   37:     0x5575c27034f5 - test::run_test::run_test_inner::{{closure}}::h5ca48a4c59c6c1fb
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/test/src/lib.rs:599:37
[INFO] [stdout]   38:     0x5575c27034f5 - std::sys_common::backtrace::__rust_begin_short_backtrace::h32bd51e1495d4a33
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys_common/backtrace.rs:134:18
[INFO] [stdout]   39:     0x5575c2708a31 - std::thread::Builder::spawn_unchecked_::{{closure}}::{{closure}}::hc086fae9b128b2db
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/thread/mod.rs:526:17
[INFO] [stdout]   40:     0x5575c2708a31 - <core::panic::unwind_safe::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::hb66571888d270d43
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/panic/unwind_safe.rs:271:9
[INFO] [stdout]   41:     0x5575c2708a31 - std::panicking::try::do_call::h4fa2ef4f6e51fecf
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:485:40
[INFO] [stdout]   42:     0x5575c2708a31 - std::panicking::try::h1e9e22b8584489b5
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panicking.rs:449:19
[INFO] [stdout]   43:     0x5575c2708a31 - std::panic::catch_unwind::h44698a3de0e0769e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/panic.rs:140:14
[INFO] [stdout]   44:     0x5575c2708a31 - std::thread::Builder::spawn_unchecked_::{{closure}}::h50153abde3fe239e
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/thread/mod.rs:525:30
[INFO] [stdout]   45:     0x5575c2708a31 - core::ops::function::FnOnce::call_once{{vtable.shim}}::hbe5bbf6f38394364
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   46:     0x5575c278afa5 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::h0d83cb2920a49046
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1973:9
[INFO] [stdout]   47:     0x5575c278afa5 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::hbe0a008aa7d9ef59
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/alloc/src/boxed.rs:1973:9
[INFO] [stdout]   48:     0x5575c278afa5 - std::sys::unix::thread::Thread::new::thread_start::h3a466996bdf6b1f9
[INFO] [stdout]                                at /rustc/1b7dd2252b99671ce5d1cb9664c5f8636329436d/library/std/src/sys/unix/thread.rs:108:17
[INFO] [stdout]   49:     0x7f0ae1e49b43 - <unknown>
[INFO] [stdout]   50:     0x7f0ae1edabb4 - __clone
[INFO] [stdout]   51:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout]     song_was_created
[INFO] [stdout]     song_was_played
[INFO] [stdout] 
[INFO] [stdout] test result: FAILED. 0 passed; 2 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stderr] error: test failed, to rerun pass `-p song-cli --test cli`
[INFO] running `Command { std: "docker" "inspect" "3e53b5620044c119830f169a3efe870bbca38513cdb37ccbc9fd822998af55eb", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "3e53b5620044c119830f169a3efe870bbca38513cdb37ccbc9fd822998af55eb", kill_on_drop: false }`
[INFO] [stdout] 3e53b5620044c119830f169a3efe870bbca38513cdb37ccbc9fd822998af55eb
