[INFO] cloning repository https://github.com/eHealthExperts/k2-creek [INFO] running `Command { std: "git" "-c" "credential.helper=" "-c" "credential.helper=/workspace/cargo-home/bin/git-credential-null" "clone" "--bare" "https://github.com/eHealthExperts/k2-creek" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FeHealthExperts%2Fk2-creek", kill_on_drop: false }` [INFO] [stderr] Cloning into bare repository '/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FeHealthExperts%2Fk2-creek'... [INFO] running `Command { std: "git" "rev-parse" "HEAD", kill_on_drop: false }` [INFO] [stdout] e9e535c6319779bdba2220face1c38b7e1191e57 [INFO] testing eHealthExperts/k2-creek against 1.60.0 for beta-1.61-1 [INFO] running `Command { std: "git" "clone" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FeHealthExperts%2Fk2-creek" "/workspace/builds/worker-1/source", kill_on_drop: false }` [INFO] [stderr] Cloning into '/workspace/builds/worker-1/source'... [INFO] [stderr] done. [INFO] validating manifest of git repo https://github.com/eHealthExperts/k2-creek on toolchain 1.60.0 [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+1.60.0" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] removed /workspace/builds/worker-1/source/.cargo/config [INFO] removed /workspace/builds/worker-1/source/rust-toolchain [INFO] started tweaking git repo https://github.com/eHealthExperts/k2-creek [INFO] finished tweaking git repo https://github.com/eHealthExperts/k2-creek [INFO] tweaked toml for git repo https://github.com/eHealthExperts/k2-creek written to /workspace/builds/worker-1/source/Cargo.toml [INFO] crate git repo https://github.com/eHealthExperts/k2-creek already has a lockfile, it will not be regenerated [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+1.60.0" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Downloading crates ... [INFO] [stderr] Downloaded serial_test_derive v0.5.1 [INFO] [stderr] Downloaded serial_test v0.5.1 [INFO] [stderr] Downloaded deadpool v0.7.0 [INFO] [stderr] Downloaded rusticata-macros v4.0.0 [INFO] [stderr] Downloaded serde-xml-rs v0.5.1 [INFO] [stderr] Downloaded promptly v0.3.0 [INFO] [stderr] Downloaded assert_cmd v2.0.1 [INFO] [stderr] Downloaded rustyline v6.3.0 [INFO] [stderr] Downloaded wiremock v0.5.7 [INFO] [stderr] Downloaded serde_with_macros v1.5.0 [INFO] [stderr] Downloaded serde_with v1.10.0 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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:eaef2f80f755933c374d2ae5edccceec0c1312ceb8a4e0b6404e8ab76561e1e5" "/opt/rustwide/cargo-home/bin/cargo" "+1.60.0" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] [stdout] ac65cf71bc1a8815d5b77558c7eeb5325b4600be940f6c679017fe14dfda3996 [INFO] running `Command { std: "docker" "start" "-a" "ac65cf71bc1a8815d5b77558c7eeb5325b4600be940f6c679017fe14dfda3996", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "ac65cf71bc1a8815d5b77558c7eeb5325b4600be940f6c679017fe14dfda3996", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "ac65cf71bc1a8815d5b77558c7eeb5325b4600be940f6c679017fe14dfda3996", kill_on_drop: false }` [INFO] [stdout] ac65cf71bc1a8815d5b77558c7eeb5325b4600be940f6c679017fe14dfda3996 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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" "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:eaef2f80f755933c374d2ae5edccceec0c1312ceb8a4e0b6404e8ab76561e1e5" "/opt/rustwide/cargo-home/bin/cargo" "+1.60.0" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] [stdout] 87da3f4b19cd4518045c209a2fcd72ce667d9255309b3200b8cf7d8aaf4b2a85 [INFO] running `Command { std: "docker" "start" "-a" "87da3f4b19cd4518045c209a2fcd72ce667d9255309b3200b8cf7d8aaf4b2a85", kill_on_drop: false }` [INFO] [stderr] Compiling syn v1.0.78 [INFO] [stderr] Compiling libc v0.2.103 [INFO] [stderr] Compiling log v0.4.14 [INFO] [stderr] Compiling futures-io v0.3.17 [INFO] [stderr] Compiling strsim v0.10.0 [INFO] [stderr] Compiling minimal-lexical v0.1.4 [INFO] [stderr] Compiling anyhow v1.0.44 [INFO] [stderr] Compiling k2-creek v1.0.1 (/opt/rustwide/workdir) [INFO] [stderr] Compiling yasna v0.4.0 [INFO] [stderr] Compiling value-bag v1.0.0-alpha.7 [INFO] [stderr] Compiling tokio v1.12.0 [INFO] [stderr] Compiling futures-util v0.3.17 [INFO] [stderr] Compiling nom v7.0.0 [INFO] [stderr] Compiling tracing v0.1.28 [INFO] [stderr] Compiling quote v1.0.10 [INFO] [stderr] Compiling regex v1.5.4 [INFO] [stderr] Compiling num_cpus v1.13.0 [INFO] [stderr] Compiling ring v0.16.20 [INFO] [stderr] Compiling openssl-sys v0.9.67 [INFO] [stderr] Compiling socket2 v0.4.2 [INFO] [stderr] Compiling dirs-sys-next v0.1.2 [INFO] [stderr] Compiling nix v0.18.0 [INFO] [stderr] Compiling atty v0.2.14 [INFO] [stderr] Compiling dirs-next v1.0.2 [INFO] [stderr] Compiling clap v2.33.3 [INFO] [stderr] Compiling rusticata-macros v4.0.0 [INFO] [stderr] Compiling openssl v0.10.36 [INFO] [stderr] Compiling webpki v0.21.4 [INFO] [stderr] Compiling sct v0.6.1 [INFO] [stderr] Compiling webpki-roots v0.21.1 [INFO] [stderr] Compiling darling_core v0.13.0 [INFO] [stderr] Compiling ctor v0.1.21 [INFO] [stderr] Compiling serde_derive v1.0.130 [INFO] [stderr] Compiling futures-macro v0.3.17 [INFO] [stderr] Compiling thiserror-impl v1.0.29 [INFO] [stderr] Compiling enum-iterator-derive v0.7.0 [INFO] [stderr] Compiling darling_macro v0.13.0 [INFO] [stderr] Compiling enum-iterator v0.7.0 [INFO] [stderr] Compiling thiserror v1.0.29 [INFO] [stderr] Compiling darling v0.13.0 [INFO] [stderr] Compiling mio v0.7.13 [INFO] [stderr] Compiling want v0.3.0 [INFO] [stderr] Compiling native-tls v0.2.8 [INFO] [stderr] Compiling rustls v0.19.1 [INFO] [stderr] Compiling rustyline v6.3.0 [INFO] [stderr] Compiling env_logger v0.9.0 [INFO] [stderr] Compiling serde_with_macros v1.5.0 [INFO] [stderr] Compiling promptly v0.3.0 [INFO] [stderr] Compiling serde v1.0.130 [INFO] [stderr] Compiling tokio-util v0.6.8 [INFO] [stderr] Compiling tokio-rustls v0.22.0 [INFO] [stderr] Compiling tokio-native-tls v0.3.0 [INFO] [stderr] Compiling h2 v0.3.6 [INFO] [stderr] Compiling url v2.2.2 [INFO] [stderr] Compiling serde_json v1.0.68 [INFO] [stderr] Compiling serde_urlencoded v0.7.0 [INFO] [stderr] Compiling config v0.11.0 [INFO] [stderr] Compiling serde_with v1.10.0 [INFO] [stderr] Compiling serde-xml-rs v0.5.1 [INFO] [stderr] Compiling hyper v0.14.13 [INFO] [stderr] Compiling hyper-rustls v0.22.1 [INFO] [stderr] Compiling hyper-tls v0.5.0 [INFO] [stderr] Compiling reqwest v0.11.4 [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 2m 59s [INFO] running `Command { std: "docker" "inspect" "87da3f4b19cd4518045c209a2fcd72ce667d9255309b3200b8cf7d8aaf4b2a85", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "87da3f4b19cd4518045c209a2fcd72ce667d9255309b3200b8cf7d8aaf4b2a85", kill_on_drop: false }` [INFO] [stdout] 87da3f4b19cd4518045c209a2fcd72ce667d9255309b3200b8cf7d8aaf4b2a85 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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" "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:eaef2f80f755933c374d2ae5edccceec0c1312ceb8a4e0b6404e8ab76561e1e5" "/opt/rustwide/cargo-home/bin/cargo" "+1.60.0" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] [stdout] e4bf96135a0d767a3586d3569fd67774f1f176f52f24bab2ef532e8fe4ecbc68 [INFO] running `Command { std: "docker" "start" "-a" "e4bf96135a0d767a3586d3569fd67774f1f176f52f24bab2ef532e8fe4ecbc68", kill_on_drop: false }` [INFO] [stderr] Compiling fastrand v1.5.0 [INFO] [stderr] Compiling predicates-core v1.0.2 [INFO] [stderr] Compiling normalize-line-endings v0.3.0 [INFO] [stderr] Compiling doc-comment v0.3.3 [INFO] [stderr] Compiling treeline v0.1.0 [INFO] [stderr] Compiling scopeguard v1.1.0 [INFO] [stderr] Compiling http-types v2.12.0 [INFO] [stderr] Compiling difflib v0.4.0 [INFO] [stderr] Compiling infer v0.2.3 [INFO] [stderr] Compiling downcast v0.10.0 [INFO] [stderr] Compiling fragile v1.0.0 [INFO] [stderr] Compiling async-mutex v1.4.0 [INFO] [stderr] Compiling async-lock v2.4.0 [INFO] [stderr] Compiling itertools v0.10.1 [INFO] [stderr] Compiling getrandom v0.1.16 [INFO] [stderr] Compiling getrandom v0.2.3 [INFO] [stderr] Compiling parking_lot_core v0.8.5 [INFO] [stderr] Compiling wait-timeout v0.2.0 [INFO] [stderr] Compiling bstr v0.2.17 [INFO] [stderr] Compiling async-channel v1.6.1 [INFO] [stderr] Compiling crossbeam-queue v0.3.2 [INFO] [stderr] Compiling lock_api v0.4.5 [INFO] [stderr] Compiling predicates-tree v1.0.3 [INFO] [stderr] Compiling rand_core v0.5.1 [INFO] [stderr] Compiling float-cmp v0.9.0 [INFO] [stderr] Compiling float-cmp v0.8.0 [INFO] [stderr] Compiling rand_core v0.6.3 [INFO] [stderr] Compiling futures-lite v1.12.0 [INFO] [stderr] Compiling async-trait v0.1.51 [INFO] [stderr] Compiling mockall_derive v0.10.2 [INFO] [stderr] Compiling async-attributes v1.1.2 [INFO] [stderr] Compiling serial_test_derive v0.5.1 [INFO] [stderr] Compiling predicates v1.0.8 [INFO] [stderr] Compiling rand_chacha v0.3.1 [INFO] [stderr] Compiling rand_chacha v0.2.2 [INFO] [stderr] Compiling config v0.10.1 [INFO] [stderr] Compiling futures-executor v0.3.17 [INFO] [stderr] Compiling serde_qs v0.8.5 [INFO] [stderr] Compiling parking_lot v0.11.2 [INFO] [stderr] Compiling polling v2.1.0 [INFO] [stderr] Compiling kv-log-macro v1.0.7 [INFO] [stderr] Compiling rand v0.7.3 [INFO] [stderr] Compiling futures v0.3.17 [INFO] [stderr] Compiling rand v0.8.4 [INFO] [stderr] Compiling blocking v1.0.2 [INFO] [stderr] Compiling async-io v1.6.0 [INFO] [stderr] Compiling async-executor v1.4.1 [INFO] [stderr] Compiling predicates v2.0.2 [INFO] [stderr] Compiling serial_test v0.5.1 [INFO] [stderr] Compiling tempfile v3.2.0 [INFO] [stderr] Compiling async-global-executor v2.0.2 [INFO] [stderr] Compiling assert_cmd v2.0.1 [INFO] [stderr] Compiling async-std v1.10.0 [INFO] [stderr] Compiling deadpool v0.7.0 [INFO] [stderr] Compiling wiremock v0.5.7 [INFO] [stderr] Compiling mockall v0.10.2 [INFO] [stderr] Compiling k2-creek v1.0.1 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 1m 37s [INFO] running `Command { std: "docker" "inspect" "e4bf96135a0d767a3586d3569fd67774f1f176f52f24bab2ef532e8fe4ecbc68", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "e4bf96135a0d767a3586d3569fd67774f1f176f52f24bab2ef532e8fe4ecbc68", kill_on_drop: false }` [INFO] [stdout] e4bf96135a0d767a3586d3569fd67774f1f176f52f24bab2ef532e8fe4ecbc68 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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" "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:eaef2f80f755933c374d2ae5edccceec0c1312ceb8a4e0b6404e8ab76561e1e5" "/opt/rustwide/cargo-home/bin/cargo" "+1.60.0" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 3ac64820e8f39c074553c9684f2f84887a13e54246abb51504da3e0f6727fdf2 [INFO] [stderr] WARNING: Your kernel does not support swap limit capabilities or the cgroup is not mounted. Memory limited without swap. [INFO] running `Command { std: "docker" "start" "-a" "3ac64820e8f39c074553c9684f2f84887a13e54246abb51504da3e0f6727fdf2", kill_on_drop: false }` [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.41s [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/k2_creek-459db5ce7b1596dd) [INFO] [stdout] [INFO] [stdout] running 46 tests [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGLgBZUZWNobmlrZXIgS3Jhbmtlbmthc3NlgQcxMzc3NTA4jwUwMDAyMIIMMTIzNDU2Nzg5MDEygwQ1MDAwkAExhQtBbWVsaWUgU2luYYcFQXBmZWyICDExMDkxOTk1iRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4B/A== [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 139, 128, 22, 84, 101, 99, 104, 110, 105, 107, 101, 114, 32, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 49, 51, 55, 55, 53, 48, 56, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 50, 131, 4, 53, 48, 48, 48, 144, 1, 49, 133, 11, 65, 109, 101, 108, 105, 101, 32, 83, 105, 110, 97, 135, 5, 65, 112, 102, 101, 108, 136, 8, 49, 49, 48, 57, 49, 57, 57, 53, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 252] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [54, 65, 63, 68, 6e, 69, 6b, 65, 72, 20, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [31, 33, 37, 37, 35, 30, 38] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGLgBZUZWNobmlrZXIgS3Jhbmtlbmthc3NlgQcxMzc3NTA4jwUwMDAyMIIMMTIzNDU2Nzg5MDEygwQ1MDAwkAExhQtBbWVsaWUgU2luYYcFQXBmZWyICDExMDkxOTk1iRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4B/A== [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [35, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [41, 6d, 65, 6c, 69, 65, 20, 53, 69, 6e, 61] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [41, 70, 66, 65, 6c] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 31, 30, 39, 31, 39, 39, 35] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 139, 128, 22, 84, 101, 99, 104, 110, 105, 107, 101, 114, 32, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 49, 51, 55, 55, 53, 48, 56, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 50, 131, 4, 53, 48, 48, 48, 144, 1, 49, 133, 11, 65, 109, 101, 108, 105, 101, 32, 83, 105, 110, 97, 135, 5, 65, 112, 102, 101, 108, 136, 8, 49, 49, 48, 57, 49, 57, 57, 53, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 252] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [fc] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [54, 65, 63, 68, 6e, 69, 6b, 65, 72, 20, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [31, 33, 37, 37, 35, 30, 38] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [35, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Techniker Krankenkasse [INFO] [stderr] KrankenKassenNummer: 1377508 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789012 [INFO] [stderr] VersichertenStatus: 5000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Amelie Sina [INFO] [stderr] FamilienName: Apfel [INFO] [stderr] GeburtsDatum: 11091995 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [41, 6d, 65, 6c, 69, 65, 20, 53, 69, 6e, 61] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [41, 70, 66, 65, 6c] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 31, 30, 39, 31, 39, 39, 35] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [fc] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Techniker Krankenkasse [INFO] [stderr] KrankenKassenNummer: 1377508 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789012 [INFO] [stderr] VersichertenStatus: 5000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Amelie Sina [INFO] [stderr] FamilienName: Apfel [INFO] [stderr] GeburtsDatum: 11091995 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::api::v1::tests] [INFO] [stderr] [INFO] [stderr] DIR [INFO] [stderr] Ok("/opt/rustwide/workdir") [INFO] [stderr] [INFO] [stderr] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGLgBZUZWNobmlrZXIgS3Jhbmtlbmthc3NlgQcxMzc3NTA4jwUwMDAyMIIMMTIzNDU2Nzg5MDEygwQ1MDAwkAExhQtBbWVsaWUgU2luYYcFQXBmZWyICDExMDkxOTk1iRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4B/A== [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 139, 128, 22, 84, 101, 99, 104, 110, 105, 107, 101, 114, 32, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 49, 51, 55, 55, 53, 48, 56, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 50, 131, 4, 53, 48, 48, 48, 144, 1, 49, 133, 11, 65, 109, 101, 108, 105, 101, 32, 83, 105, 110, 97, 135, 5, 65, 112, 102, 101, 108, 136, 8, 49, 49, 48, 57, 49, 57, 57, 53, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 252] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGLgBZUZWNobmlrZXIgS3Jhbmtlbmthc3NlgQcxMzc3NTA4jwUwMDAyMIIMMTIzNDU2Nzg5MDEygwQ1MDAwkAExhQtBbWVsaWUgU2luYYcFQXBmZWyICDExMDkxOTk1iRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4B/A== [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 139, 128, 22, 84, 101, 99, 104, 110, 105, 107, 101, 114, 32, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 49, 51, 55, 55, 53, 48, 56, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 50, 131, 4, 53, 48, 48, 48, 144, 1, 49, 133, 11, 65, 109, 101, 108, 105, 101, 32, 83, 105, 110, 97, 135, 5, 65, 112, 102, 101, 108, 136, 8, 49, 49, 48, 57, 49, 57, 57, 53, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 252] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [54, 65, 63, 68, 6e, 69, 6b, 65, 72, 20, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [54, 65, 63, 68, 6e, 69, 6b, 65, 72, 20, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [31, 33, 37, 37, 35, 30, 38] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [31, 33, 37, 37, 35, 30, 38] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [35, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [41, 6d, 65, 6c, 69, 65, 20, 53, 69, 6e, 61] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [41, 70, 66, 65, 6c] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 31, 30, 39, 31, 39, 39, 35] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [fc] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Techniker Krankenkasse [INFO] [stderr] KrankenKassenNummer: 1377508 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789012 [INFO] [stderr] VersichertenStatus: 5000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Amelie Sina [INFO] [stderr] FamilienName: Apfel [INFO] [stderr] GeburtsDatum: 11091995 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [35, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [41, 6d, 65, 6c, 69, 65, 20, 53, 69, 6e, 61] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [41, 70, 66, 65, 6c] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 31, 30, 39, 31, 39, 39, 35] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [fc] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Techniker Krankenkasse [INFO] [stderr] KrankenKassenNummer: 1377508 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789012 [INFO] [stderr] VersichertenStatus: 5000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Amelie Sina [INFO] [stderr] FamilienName: Apfel [INFO] [stderr] GeburtsDatum: 11091995 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stdout] test api::v1::tests::deserialize_kvk_carddata ... ok [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::cli] Msg error: The following required arguments were not provided: [INFO] [stdout] test api::tests::deserialize_kvk_carddata_v1 ... ok [INFO] [stderr] --url [INFO] [stdout] test api::v1::tests::deserialize_egk_carddata ... ok [INFO] [stderr] [INFO] [stdout] test api::tests::deserialize_egk_carddata_v1 ... ok [INFO] [stderr] USAGE: [INFO] [stdout] test api::v2::tests::deserialize_egk_carddata ... ok [INFO] [stderr] test --api --url [INFO] [stdout] test api::tests::deserialize_kvk_carddata_v2 ... ok [INFO] [stderr] [INFO] [stdout] test api::tests::deserialize_egk_carddata_v2 ... ok [INFO] [stderr] For more information try --help [INFO] [stdout] test api::tests::deserialize_egk_carddata_v3 ... ok [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::cli] Msg error: The following required arguments were not provided: [INFO] [stderr] --url [INFO] [stderr] [INFO] [stderr] USAGE: [INFO] [stderr] test --output --url [INFO] [stderr] [INFO] [stderr] For more information try --help [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::cli] Msg error: The following required arguments were not provided: [INFO] [stderr] --url [INFO] [stderr] [INFO] [stderr] USAGE: [INFO] [stderr] test -f --url [INFO] [stderr] [INFO] [stderr] For more information try --help [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::cli] Msg error: The following required arguments were not provided: [INFO] [stderr] --url [INFO] [stderr] [INFO] [stderr] USAGE: [INFO] [stderr] test --output --url [INFO] [stderr] [INFO] [stderr] For more information try --help [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::cli] Msg error: The following required arguments were not provided: [INFO] [stderr] --url [INFO] [stderr] [INFO] [stderr] USAGE: [INFO] [stderr] test --timeout --url [INFO] [stderr] [INFO] [stderr] For more information try --help [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::cli] Msg error: The following required arguments were not provided: [INFO] [stderr] --url [INFO] [stderr] [INFO] [stderr] USAGE: [INFO] [stderr] test --timeout --url [INFO] [stderr] [INFO] [stderr] For more information try --help [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stdout] test api::tests::deserialize_kvk_carddata_v3 ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(30)) park without timeout [INFO] [stdout] test config::tests::no_valid_url_parameter ... ignored [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: completed [INFO] [stdout] test cli::required_argument_url ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGLgBZUZWNobmlrZXIgS3Jhbmtlbmthc3NlgQcxMzc3NTA4jwUwMDAyMIIMMTIzNDU2Nzg5MDEygwQ1MDAwkAExhQtBbWVsaWUgU2luYYcFQXBmZWyICDExMDkxOTk1iRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4B/A== [INFO] [stdout] test config::tests::defaults ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_std::task::builder] block_on [INFO] [stdout] test cli::tests::allowed_values_for_api ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stdout] test config::tests::default_configuration ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 139, 128, 22, 84, 101, 99, 104, 110, 105, 107, 101, 114, 32, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 49, 51, 55, 55, 53, 48, 56, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 50, 131, 4, 53, 48, 48, 48, 144, 1, 49, 133, 11, 65, 109, 101, 108, 105, 101, 32, 83, 105, 110, 97, 135, 5, 65, 112, 102, 101, 108, 136, 8, 49, 49, 48, 57, 49, 57, 57, 53, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 252] [INFO] [stdout] test egk::tests::write_mfefgdo_failed ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [54, 65, 63, 68, 6e, 69, 6b, 65, 72, 20, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stdout] test egk::tests::write_mfefgdo_ok ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [31, 33, 37, 37, 35, 30, 38] [INFO] [stdout] test api::v2::tests::deserialize_kvk_carddata ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [35, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [41, 6d, 65, 6c, 69, 65, 20, 53, 69, 6e, 61] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [41, 70, 66, 65, 6c] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 31, 30, 39, 31, 39, 39, 35] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [fc] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Techniker Krankenkasse [INFO] [stderr] KrankenKassenNummer: 1377508 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789012 [INFO] [stderr] VersichertenStatus: 5000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Amelie Sina [INFO] [stderr] FamilienName: Apfel [INFO] [stderr] GeburtsDatum: 11091995 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stderr] [2022-04-15T07:29:16Z TRACE polling::epoll] add: epoll_fd=4, fd=6, ev=Event { key: 18446744073709551615, readable: false, writable: false } [INFO] [stderr] [2022-04-15T07:29:16Z TRACE polling::epoll] add: epoll_fd=4, fd=5, ev=Event { key: 18446744073709551615, readable: true, writable: false } [INFO] [stderr] [2022-04-15T07:29:16Z TRACE polling::epoll] new: epoll_fd=4, event_fd=5, timer_fd=Some(6) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: waiting on I/O [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::reactor] process_timers: 0 ready wakers [INFO] [stderr] [2022-04-15T07:29:16Z TRACE polling] Poller::wait(_, None) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE polling::epoll] wait: epoll_fd=4, timeout=None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE polling::epoll] modify: epoll_fd=4, fd=6, ev=Event { key: 18446744073709551615, readable: true, writable: false } [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 50 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: notified [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 50 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 75 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 100 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 250 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(38)) start runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closing runtime thread (ThreadId(38)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] signaled close for runtime thread (ThreadId(38)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 500 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_std::task::builder] block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(1), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 750 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(49)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(38)) Receiver is shutdown [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(38)) end runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(38)) finished [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closed runtime thread (ThreadId(38)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(30)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 1000 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(54)) start runtime::block_on [INFO] [stdout] test http::tests::build_client_timeout ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closing runtime thread (ThreadId(54)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] signaled close for runtime thread (ThreadId(54)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 2500 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(54)) Receiver is shutdown [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(54)) end runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(54)) finished [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closed runtime thread (ThreadId(54)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(29)) park without timeout [INFO] [stdout] test api::v3::tests::deserialize_kvk_carddata ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 5000 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGLgBZUZWNobmlrZXIgS3Jhbmtlbmthc3NlgQcxMzc3NTA4jwUwMDAyMIIMMTIzNDU2Nzg5MDEygwQ1MDAwkAExhQtBbWVsaWUgU2luYYcFQXBmZWyICDExMDkxOTk1iRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4B/A== [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 139, 128, 22, 84, 101, 99, 104, 110, 105, 107, 101, 114, 32, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 49, 51, 55, 55, 53, 48, 56, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 50, 131, 4, 53, 48, 48, 48, 144, 1, 49, 133, 11, 65, 109, 101, 108, 105, 101, 32, 83, 105, 110, 97, 135, 5, 65, 112, 102, 101, 108, 136, 8, 49, 49, 48, 57, 49, 57, 57, 53, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 252] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [54, 65, 63, 68, 6e, 69, 6b, 65, 72, 20, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [31, 33, 37, 37, 35, 30, 38] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [35, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [41, 6d, 65, 6c, 69, 65, 20, 53, 69, 6e, 61] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [41, 70, 66, 65, 6c] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 31, 30, 39, 31, 39, 39, 35] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [fc] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Techniker Krankenkasse [INFO] [stderr] KrankenKassenNummer: 1377508 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789012 [INFO] [stderr] VersichertenStatus: 5000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Amelie Sina [INFO] [stderr] FamilienName: Apfel [INFO] [stderr] GeburtsDatum: 11091995 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(1), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] main_loop: sleeping for 10000 us [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stdout] test api::v3::tests::deserialize_egk_carddata ... ok [INFO] [stdout] test egk::tests::pn_is_written ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(57)) start runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::http] Requesting http://127.0.0.1:32849/k2/public/api/1/carddata ... [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(29)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::connect] starting new connection: http://127.0.0.1:32849/ [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal found waiting giver, notifying [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] poll_want: taker wants! [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpgs63FD [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_Pruefungsnachweis.xml" [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmpgs63FD/eGK_Pruefungsnachweis.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpgs63FD [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stdout] test egk::tests::gvd_is_written ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stdout] test kvk::fmt::tests::fmt_not_replaces_latin_alphabet_and_arabic_numbers ... ok [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpl9ADz9 [INFO] [stdout] test kvk::fmt::tests::fmt_replaces_chars_according_to_din_66003 ... ok [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stdout] test egk::tests::all_files_written ... ok [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_geschuetzteVersichertendaten.xml" [INFO] [stdout] test writer::encode::tests::encoding_from_xml_declaration_or_default ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stdout] test egk::mfefgdo::tests::valid_xml_layout ... ok [INFO] [stderr] "/tmp/.tmpl9ADz9/eGK_geschuetzteVersichertendaten.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpl9ADz9 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmp7R4x3c [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_PersoenlicheVersichertendaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_allgemeineVersicherungsdaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_MFDF_HCA_EF_StatusVD.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_geschuetzteVersichertendaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_Pruefungsnachweis.xml" [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmp7R4x3c/eGK_PersoenlicheVersichertendaten.xml", [INFO] [stderr] "/tmp/.tmp7R4x3c/eGK_MFDF_HCA_EF_StatusVD.xml", [INFO] [stderr] "/tmp/.tmp7R4x3c/eGK_allgemeineVersicherungsdaten.xml", [INFO] [stderr] "/tmp/.tmp7R4x3c/eGK_geschuetzteVersichertendaten.xml", [INFO] [stderr] "/tmp/.tmp7R4x3c/eGK_Pruefungsnachweis.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmp7R4x3c [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpl5Yhrh [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_MFEFGDO.xml" [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmpl5Yhrh/eGK_MFEFGDO.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpl5Yhrh [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stdout] test config::tests::config_file_overrides ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stdout] test writer::encode::tests::xml_declaration_is_added ... ok [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpWc4mnW [INFO] [stdout] test writer::encode::tests::xml_declaration_is_not_added ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stdout] test egk::tests::status_vd_is_written ... ok [INFO] [stderr] "/tmp/.tmpWc4mnW/config.ini", [INFO] [stdout] test egk::tests::vd_is_written ... ok [INFO] [stderr] ] [INFO] [stdout] test egk::tests::pd_is_written ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpWc4mnW [INFO] [stdout] test config::tests::config_file_missing ... ok [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpMMFrKJ [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpMMFrKJ [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmp9REDZl [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_MFDF_HCA_EF_StatusVD.xml" [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: sleep until notification [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmp9REDZl/eGK_MFDF_HCA_EF_StatusVD.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmp9REDZl [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(53)) start runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpfhAiCx [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_allgemeineVersicherungsdaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmpfhAiCx/eGK_allgemeineVersicherungsdaten.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpfhAiCx [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::http] Requesting http://127.0.0.1:46343/k2/public/api/1/carddata ... [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] wait at most 2s [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(49)) park timeout 1.999989299s [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpM57RdZ [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "eGK_PersoenlicheVersichertendaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::connect] starting new connection: http://127.0.0.1:46343/ [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmpM57RdZ/eGK_PersoenlicheVersichertendaten.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpM57RdZ [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal found waiting giver, notifying [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] poll_want: taker wants! [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmps4COvp [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_std::task::builder] block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on() [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGLgBZUZWNobmlrZXIgS3Jhbmtlbmthc3NlgQcxMzc3NTA4jwUwMDAyMIIMMTIzNDU2Nzg5MDEygwQ1MDAwkAExhQtBbWVsaWUgU2luYYcFQXBmZWyICDExMDkxOTk1iRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4B/A== [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 139, 128, 22, 84, 101, 99, 104, 110, 105, 107, 101, 114, 32, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 49, 51, 55, 55, 53, 48, 56, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 50, 131, 4, 53, 48, 48, 48, 144, 1, 49, 133, 11, 65, 109, 101, 108, 105, 101, 32, 83, 105, 110, 97, 135, 5, 65, 112, 102, 101, 108, 136, 8, 49, 49, 48, 57, 49, 57, 57, 53, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 252] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [54, 65, 63, 68, 6e, 69, 6b, 65, 72, 20, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [31, 33, 37, 37, 35, 30, 38] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [35, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [41, 6d, 65, 6c, 69, 65, 20, 53, 69, 6e, 61] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [41, 70, 66, 65, 6c] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 31, 30, 39, 31, 39, 39, 35] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stdout] test writer::files::tests::filenames ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stdout] test writer::tests::not_prompting_before_cleanup ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [fc] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(16777217), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(1), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(71)) start runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG wiremock::mock_set] Handling request. [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(50)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Techniker Krankenkasse [INFO] [stderr] KrankenKassenNummer: 1377508 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789012 [INFO] [stderr] VersichertenStatus: 5000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Amelie Sina [INFO] [stderr] FamilienName: Apfel [INFO] [stderr] GeburtsDatum: 11091995 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Deleted "eGK_allgemeineVersicherungsdaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Deleted "eGK_geschuetzteVersichertendaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Deleted "eGK_PersoenlicheVersichertendaten.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Deleted "eGK_MFDF_HCA_EF_StatusVD.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Deleted "eGK_Pruefungsnachweis.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Deleted "eGK_MFEFGDO.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Deleted "Result.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "Result.xml" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "KVK.dat" [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "KVK_Daten.bin" [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmps4COvp/Result.xml", [INFO] [stderr] "/tmp/.tmps4COvp/KVK.dat", [INFO] [stderr] "/tmp/.tmps4COvp/KVK_Daten.bin", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmps4COvp/Result.xml", [INFO] [stderr] "/tmp/.tmps4COvp/KVK.dat", [INFO] [stderr] "/tmp/.tmps4COvp/KVK_Daten.bin", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmps4COvp [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::http] Requesting http://127.0.0.1:34337/k2/public/api/1/carddata ... [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(50)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(16777217), interests=READABLE | WRITABLE [INFO] [stdout] test http::tests::supported_api_version ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Decoded: YIGXgBpCdW5kZXNwb2xpemVpLUtyYW5rZW5rYXNzZYEHMzYwMDM0Mo8FMDAwMjCCDDEyMzQ1Njc4OTAxM4MEMTAwMJABMYUSRGFuaWVsIEd1c3RhdiBMdXR6hwZIfG5zY2iICDE3MDUxOTYxiRJDYXJsLVdvbGZmLVN0ci4gMTKKAUSLBTQ1Mjc5jAVFc3Nlbo0EMTAyMY4BiA== [INFO] [stdout] test kvk::fmt::tests::fmt_returns_error_string_if_invalid_bytes_given ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] Encoded: [96, 129, 151, 128, 26, 66, 117, 110, 100, 101, 115, 112, 111, 108, 105, 122, 101, 105, 45, 75, 114, 97, 110, 107, 101, 110, 107, 97, 115, 115, 101, 129, 7, 51, 54, 48, 48, 51, 52, 50, 143, 5, 48, 48, 48, 50, 48, 130, 12, 49, 50, 51, 52, 53, 54, 55, 56, 57, 48, 49, 51, 131, 4, 49, 48, 48, 48, 144, 1, 49, 133, 18, 68, 97, 110, 105, 101, 108, 32, 71, 117, 115, 116, 97, 118, 32, 76, 117, 116, 122, 135, 6, 72, 124, 110, 115, 99, 104, 136, 8, 49, 55, 48, 53, 49, 57, 54, 49, 137, 18, 67, 97, 114, 108, 45, 87, 111, 108, 102, 102, 45, 83, 116, 114, 46, 32, 49, 50, 138, 1, 68, 139, 5, 52, 53, 50, 55, 57, 140, 5, 69, 115, 115, 101, 110, 141, 4, 49, 48, 50, 49, 142, 1, 136] [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::connect] starting new connection: http://127.0.0.1:34337/ [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kkn [42, 75, 6e, 64, 65, 73, 70, 6f, 6c, 69, 7a, 65, 69, 2d, 4b, 72, 61, 6e, 6b, 65, 6e, 6b, 61, 73, 73, 65] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] kknr [33, 36, 30, 30, 33, 34, 32] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vknr [30, 30, 30, 32, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vnr [31, 32, 33, 34, 35, 36, 37, 38, 39, 30, 31, 33] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] vs [31, 30, 30, 30] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] se [31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] t None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] v [44, 61, 6e, 69, 65, 6c, 20, 47, 75, 73, 74, 61, 76, 20, 4c, 75, 74, 7a] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] nz None [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] f [48, 7c, 6e, 73, 63, 68] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] gd [31, 37, 30, 35, 31, 39, 36, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] sn Some([43, 61, 72, 6c, 2d, 57, 6f, 6c, 66, 66, 2d, 53, 74, 72, 2e, 20, 31, 32]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] wlc Some([44]) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] plz [34, 35, 32, 37, 39] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] on [45, 73, 73, 65, 6e] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] g [31, 30, 32, 31] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG wiremock::mock_set] Handling request. [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(16777217), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal found waiting giver, notifying [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] poll_want: taker wants! [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::async_impl::client] response '200 OK' for http://127.0.0.1:32849/k2/public/api/1/carddata [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG wiremock::mock_set] Handling request. [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::http] Response { url: Url { scheme: "http", cannot_be_a_base: false, username: "", password: None, host: Some(Ipv4(127.0.0.1)), port: Some(32849), path: "/k2/public/api/1/carddata", query: None, fragment: None }, status: 200, headers: {"content-type": "application/json", "content-length": "2", "date": "Fri, 15 Apr 2022 07:29:16 GMT"} } [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closing runtime thread (ThreadId(57)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] signaled close for runtime thread (ThreadId(57)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk::parser] ps [88] [INFO] [stdout] test kvk::test::decode_base64_encoded_asn1_data ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::kvk] ASN.1 decoded: [INFO] [stderr] KrankenKassenName: Bundespolizei-Krankenkasse [INFO] [stderr] KrankenKassenNummer: 3600342 [INFO] [stderr] VKNR: 00020 [INFO] [stderr] VersichertenNummer: 123456789013 [INFO] [stderr] VersichertenStatus: 1000 [INFO] [stderr] StatusErgänzung: 1 [INFO] [stderr] VorName: Daniel Gustav Lutz [INFO] [stderr] FamilienName: Hönsch [INFO] [stderr] GeburtsDatum: 17051961 [INFO] [stderr] Straßenname: Carl-Wolff-Str. 12 [INFO] [stderr] WohnsitzLänderCode: D [INFO] [stderr] Postleitzahl: 45279 [INFO] [stderr] Orstname: Essen [INFO] [stderr] GültigkeitsDatum: 1021 [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(57)) Receiver is shutdown [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(57)) end runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Closed [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(57)) finished [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closed runtime thread (ThreadId(57)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(29)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(73)) start runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::http] Requesting http://127.0.0.1:32849/k2/public/api/3/cards ... [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(29)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::connect] starting new connection: http://127.0.0.1:32849/ [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal found waiting giver, notifying [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] poll_want: taker wants! [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(33554433), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG wiremock::mock_set] Handling request. [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::async_impl::client] response '200 OK' for http://127.0.0.1:32849/k2/public/api/3/cards [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::http] Response { url: Url { scheme: "http", cannot_be_a_base: false, username: "", password: None, host: Some(Ipv4(127.0.0.1)), port: Some(32849), path: "/k2/public/api/3/cards", query: None, fragment: None }, status: 200, headers: {"content-type": "application/json", "content-length": "2", "date": "Fri, 15 Apr 2022 07:29:16 GMT"} } [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closing runtime thread (ThreadId(73)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] signaled close for runtime thread (ThreadId(73)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stdout] test http::tests::build_client_api_endpoint ... ok [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(73)) Receiver is shutdown [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(73)) end runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Closed [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(73)) finished [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closed runtime thread (ThreadId(73)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(29)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(74)) start runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::http] Requesting http://127.0.0.1:32849/k2/public/api/2/carddata ... [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::wait] (ThreadId(29)) park without timeout [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::connect] starting new connection: http://127.0.0.1:32849/ [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(0), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal found waiting giver, notifying [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] poll_want: taker wants! [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] registering event source with poller: token=Token(50331649), interests=READABLE | WRITABLE [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG wiremock::mock_set] Handling request. [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG reqwest::async_impl::client] response '200 OK' for http://127.0.0.1:32849/k2/public/api/2/carddata [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::http] Response { url: Url { scheme: "http", cannot_be_a_base: false, username: "", password: None, host: Some(Ipv4(127.0.0.1)), port: Some(32849), path: "/k2/public/api/2/carddata", query: None, fragment: None }, status: 200, headers: {"content-type": "application/json", "content-length": "2", "date": "Fri, 15 Apr 2022 07:29:16 GMT"} } [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closing runtime thread (ThreadId(74)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] signaled close for runtime thread (ThreadId(74)) [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(74)) Receiver is shutdown [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(74)) end runtime::block_on [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:16Z TRACE want] signal: Closed [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] (ThreadId(74)) finished [INFO] [stderr] [2022-04-15T07:29:16Z TRACE reqwest::blocking::client] closed runtime thread (ThreadId(74)) [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG wiremock::mock_server::exposed_server] Verify mock expectations. [INFO] [stderr] [2022-04-15T07:29:16Z TRACE async_io::driver] block_on: completed [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /tmp/.tmpjFZwkc [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::encode] No encoding found. Defaulting to iso-8859-15 [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::writer::files] Wrote file "Result.xml" [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Files: [ [INFO] [stderr] "/tmp/.tmpjFZwkc/Result.xml", [INFO] [stderr] ] [INFO] [stderr] [2022-04-15T07:29:16Z TRACE k2_creek::tests] Leaving /tmp/.tmpjFZwkc [INFO] [stderr] [2022-04-15T07:29:16Z DEBUG k2_creek::tests] Current dir: /opt/rustwide/workdir [INFO] [stdout] test writer::results::tests::optional_values_are_null ... ok [INFO] [stdout] test http::tests::build_client_wrong_api - should panic ... ok [INFO] [stdout] test http::tests::unsupported_api_version_four - should panic ... ok [INFO] [stdout] test http::tests::unsupported_api_version_zero - should panic ... ok [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::wait] wait timeout exceeded [INFO] [stdout] test http::tests::build_client_with_timeout ... ok [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] closing runtime thread (ThreadId(53)) [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] signaled close for runtime thread (ThreadId(53)) [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] (ThreadId(53)) Receiver is shutdown [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] (ThreadId(53)) end runtime::block_on [INFO] [stderr] [2022-04-15T07:29:18Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:18Z TRACE want] signal: Closed [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] (ThreadId(53)) finished [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] closed runtime thread (ThreadId(53)) [INFO] [stderr] [2022-04-15T07:29:18Z DEBUG wiremock::mock_server::exposed_server] Verify mock expectations. [INFO] [stderr] [2022-04-15T07:29:18Z TRACE async_io::driver] block_on: completed [INFO] [stderr] [2022-04-15T07:29:18Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:18Z TRACE want] signal: Want [INFO] [stdout] test http::tests::build_client_without_timeout ... ok [INFO] [stderr] [2022-04-15T07:29:18Z TRACE want] signal: Want [INFO] [stdout] [INFO] [stderr] [2022-04-15T07:29:18Z DEBUG reqwest::async_impl::client] response '200 OK' for http://127.0.0.1:34337/k2/public/api/1/carddata [INFO] [stdout] test result: ok. 45 passed; 0 failed; 1 ignored; 0 measured; 0 filtered out; finished in 2.16s [INFO] [stderr] [2022-04-15T07:29:18Z TRACE k2_creek::http] Response { url: Url { scheme: "http", cannot_be_a_base: false, username: "", password: None, host: Some(Ipv4(127.0.0.1)), port: Some(34337), path: "/k2/public/api/1/carddata", query: None, fragment: None }, status: 200, headers: {"content-type": "application/json", "content-length": "13", "date": "Fri, 15 Apr 2022 07:29:18 GMT"} } [INFO] [stdout] [INFO] [stderr] [2022-04-15T07:29:18Z TRACE want] signal: Want [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] closing runtime thread (ThreadId(71)) [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] signaled close for runtime thread (ThreadId(71)) [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] (ThreadId(71)) Receiver is shutdown [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] (ThreadId(71)) end runtime::block_on [INFO] [stderr] [2022-04-15T07:29:18Z TRACE mio::poll] deregistering event source from poller [INFO] [stderr] [2022-04-15T07:29:18Z TRACE want] signal: Closed [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] (ThreadId(71)) finished [INFO] [stderr] [2022-04-15T07:29:18Z TRACE reqwest::blocking::client] closed runtime thread (ThreadId(71)) [INFO] [stderr] [2022-04-15T07:29:18Z DEBUG wiremock::mock_server::exposed_server] Verify mock expectations. [INFO] [stderr] [2022-04-15T07:29:18Z TRACE async_io::driver] block_on: completed [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/k2_creek-ecdb4c0194054fb4) [INFO] [stdout] [INFO] [stderr] Running tests/cli.rs (/opt/rustwide/target/debug/deps/cli-534b5269e6603ca5) [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] [stdout] [INFO] [stdout] running 2 tests [INFO] [stdout] test help_is_displayed ... ok [INFO] [stdout] test usage_is_displayed ... ok [INFO] [stderr] Doc-tests k2-creek [INFO] [stdout] [INFO] [stdout] test result: ok. 2 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.15s [INFO] [stdout] [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] running `Command { std: "docker" "inspect" "3ac64820e8f39c074553c9684f2f84887a13e54246abb51504da3e0f6727fdf2", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "3ac64820e8f39c074553c9684f2f84887a13e54246abb51504da3e0f6727fdf2", kill_on_drop: false }` [INFO] [stdout] 3ac64820e8f39c074553c9684f2f84887a13e54246abb51504da3e0f6727fdf2