[INFO] fetching crate kanata-keyberon 0.1100.0...
[INFO] testing kanata-keyberon-0.1100.0 against master#350d0ef0ec0493e6d21cfb265cb8211a0e74d766 for pr-145330-1
[INFO] extracting crate kanata-keyberon 0.1100.0 into /workspace/builds/worker-3-tc1/source
[INFO] started tweaking crates.io crate kanata-keyberon 0.1100.0
[INFO] finished tweaking crates.io crate kanata-keyberon 0.1100.0
[INFO] tweaked toml for crates.io crate kanata-keyberon 0.1100.0 written to /workspace/builds/worker-3-tc1/source/Cargo.toml
[INFO] validating manifest of crates.io crate kanata-keyberon 0.1100.0 on toolchain 350d0ef0ec0493e6d21cfb265cb8211a0e74d766
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+350d0ef0ec0493e6d21cfb265cb8211a0e74d766" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate crates.io crate kanata-keyberon 0.1100.0 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" "+350d0ef0ec0493e6d21cfb265cb8211a0e74d766" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] [stderr]     Updating crates.io index
[INFO] [stderr]  Downloading crates ...
[INFO] [stderr]   Downloaded kanata-keyberon-macros v0.2.0
[INFO] [stderr]   Downloaded atomic-polyfill v1.0.3
[INFO] [stderr]   Downloaded hash32 v0.2.1
[INFO] [stderr]   Downloaded heapless v0.7.17
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+350d0ef0ec0493e6d21cfb265cb8211a0e74d766" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] f811bda0bd314d7f3fe77f882de507d34dca1b2d6b3741ac935eae00bf13316f
[INFO] running `Command { std: "docker" "start" "-a" "f811bda0bd314d7f3fe77f882de507d34dca1b2d6b3741ac935eae00bf13316f", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "f811bda0bd314d7f3fe77f882de507d34dca1b2d6b3741ac935eae00bf13316f", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "f811bda0bd314d7f3fe77f882de507d34dca1b2d6b3741ac935eae00bf13316f", kill_on_drop: false }`
[INFO] [stdout] f811bda0bd314d7f3fe77f882de507d34dca1b2d6b3741ac935eae00bf13316f
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+350d0ef0ec0493e6d21cfb265cb8211a0e74d766" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] f7671f0ce4c15095ee772dba94c10d61d150864e86821b5f7d0cd7db102c4759
[INFO] running `Command { std: "docker" "start" "-a" "f7671f0ce4c15095ee772dba94c10d61d150864e86821b5f7d0cd7db102c4759", kill_on_drop: false }`
[INFO] [stderr]    Compiling semver v1.0.23
[INFO] [stderr]    Compiling proc-macro2 v1.0.89
[INFO] [stderr]    Compiling stable_deref_trait v1.2.0
[INFO] [stderr]    Compiling arraydeque v0.5.1
[INFO] [stderr]    Compiling hash32 v0.2.1
[INFO] [stderr]    Compiling spin v0.9.8
[INFO] [stderr]    Compiling rustc_version v0.4.1
[INFO] [stderr]    Compiling heapless v0.7.17
[INFO] [stderr]    Compiling quote v1.0.37
[INFO] [stderr]    Compiling kanata-keyberon-macros v0.2.0
[INFO] [stderr]    Compiling kanata-keyberon v0.1100.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `dev` profile [unoptimized + debuginfo] target(s) in 2.92s
[INFO] running `Command { std: "docker" "inspect" "f7671f0ce4c15095ee772dba94c10d61d150864e86821b5f7d0cd7db102c4759", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "f7671f0ce4c15095ee772dba94c10d61d150864e86821b5f7d0cd7db102c4759", kill_on_drop: false }`
[INFO] [stdout] f7671f0ce4c15095ee772dba94c10d61d150864e86821b5f7d0cd7db102c4759
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+350d0ef0ec0493e6d21cfb265cb8211a0e74d766" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] b2978845978bb534cda659eec7e271b61a8cb1068a20306827a685da22d14c58
[INFO] running `Command { std: "docker" "start" "-a" "b2978845978bb534cda659eec7e271b61a8cb1068a20306827a685da22d14c58", kill_on_drop: false }`
[INFO] [stderr]    Compiling kanata-keyberon v0.1100.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 2.99s
[INFO] running `Command { std: "docker" "inspect" "b2978845978bb534cda659eec7e271b61a8cb1068a20306827a685da22d14c58", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "b2978845978bb534cda659eec7e271b61a8cb1068a20306827a685da22d14c58", kill_on_drop: false }`
[INFO] [stdout] b2978845978bb534cda659eec7e271b61a8cb1068a20306827a685da22d14c58
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+350d0ef0ec0493e6d21cfb265cb8211a0e74d766" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] 8ee58f2656b810d2b3f09587a30ba87f4912fe83a0a2afc37d6ea79b961ff834
[INFO] running `Command { std: "docker" "start" "-a" "8ee58f2656b810d2b3f09587a30ba87f4912fe83a0a2afc37d6ea79b961ff834", kill_on_drop: false }`
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 0.06s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/kanata_keyberon-cff33d185d0db451)
[INFO] [stdout] 
[INFO] [stdout] running 77 tests
[INFO] [stdout] test action::switch::bool_evaluation_test_10 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_11 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_1 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_2 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_12 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_3 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_4 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_5 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_6 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_9 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_7 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_0 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_max_depth_does_not_panic ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_0 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_1 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_2 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_3 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_4 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_5 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_8 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_9 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_6 ... ok
[INFO] [stdout] test action::switch::switch_historical_inputs ... ok
[INFO] [stdout] test action::switch::switch_inputs ... ok
[INFO] [stdout] test action::switch::switch_historical_ticks_since ... ok
[INFO] [stdout] test key_code::keycode_max_test ... ok
[INFO] [stdout] test layout::check_queue_size ... ok
[INFO] [stdout] test layout::extra_waiting_size_constraint ... ok
[INFO] [stdout] test layout::test::basic_hold_tap_repress_timeout ... ok
[INFO] [stdout] test layout::test::custom ... ok
[INFO] [stdout] test layout::test::hold_on_press ... ok
[INFO] [stdout] test action::switch::switch_no_actions ... ok
[INFO] [stdout] test action::switch::switch_historical_bools ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_or_equivalency_not_6 ... ok
[INFO] [stdout] test action::switch::switch_break ... ok
[INFO] [stdout] test layout::test::custom_handler ... ok
[INFO] [stdout] test layout::test::basic_hold_tap ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_not_7 ... ok
[INFO] [stdout] test layout::test::multiple_layers ... ok
[INFO] [stdout] test layout::test::hold_tap_interleaved_timeout ... ok
[INFO] [stdout] test layout::test::one_shot ... ok
[INFO] [stdout] test layout::test::multiple_actions ... ok
[INFO] [stdout] test action::switch::switch_historical_1 ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_or_equivalency_not_7 ... ok
[INFO] [stdout] test action::switch::switch_fallthrough ... ok
[INFO] [stdout] test layout::test::one_shot_end_on_release ... ok
[INFO] [stdout] test layout::test::one_shot_multi ... ok
[INFO] [stdout] test layout::test::one_shot_tap_hold ... ok
[INFO] [stdout] test action::switch::bool_evaluation_test_more_than_max_depth_panics - should panic ... ok
[INFO] [stdout] test layout::test::release_state ... ok
[INFO] [stdout] test layout::test::test_chord_normalkey_order ... ok
[INFO] [stdout] test layout::test::tap_hold_interval_interleave ... ok
[INFO] [stdout] test layout::test::test_clear_multiple_keycodes ... ok
[INFO] [stdout] test layout::test::test_multiple_taphold_trans ... ok
[INFO] [stdout] test layout::test::simultaneous_hold ... ok
[INFO] [stdout] test layout::test::test_trans_in_fork ... ok
[INFO] [stdout] test layout::test::tap_dance_uneager ... ok
[INFO] [stdout] test layout::test::one_shot_end_press_or_repress ... ok
[INFO] [stdout] test layout::test::test_chord ... ok
[INFO] [stdout] test layout::test::test_trans_in_tapdance_eager ... ok
[INFO] [stdout] test layout::test::test_chord_multi_waiting_decomposition ... ok
[INFO] [stdout] test layout::test::test_trans_in_switch ... ok
[INFO] [stdout] test layout::test::test_repeat ... ok
[INFO] [stdout] test layout::test::tap_hold_interval ... ok
[INFO] [stdout] test layout::test::test_trans_in_taphold_tap ... ok
[INFO] [stdout] test layout::test::test_trans_in_action_on_first_layer ... ok
[INFO] [stdout] test layout::test::test_trans_in_stacked_held_layers ... ok
[INFO] [stdout] test layout::test::trans_in_multi_works_with_all_trans_settings ... ok
[INFO] [stdout] test layout::test::test_trans_in_chords ... ok
[INFO] [stdout] test layout::test::test_trans_in_multi ... ok
[INFO] [stdout] test layout::test::tap_hold_interval_different_hold ... ok
[INFO] [stdout] test layout::test::test_fork ... ok
[INFO] [stdout] test layout::test::tap_hold_interval_short_hold ... ok
[INFO] [stdout] test layout::test::test_trans_in_tapdance_lazy ... ok
[INFO] [stdout] test layout::test::tap_dance_eager ... ok
[INFO] [stdout] test layout::test::test_trans_in_taphold_hold ... ok
[INFO] [stderr]    Doc-tests kanata_keyberon
[INFO] [stdout] test layout::test::permissive_hold ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 77 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.12s
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] running 1 test
[INFO] [stdout] test src/layout.rs - layout::Event::transform (line 191) ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 1 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.32s
[INFO] [stdout] 
[INFO] running `Command { std: "docker" "inspect" "8ee58f2656b810d2b3f09587a30ba87f4912fe83a0a2afc37d6ea79b961ff834", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "8ee58f2656b810d2b3f09587a30ba87f4912fe83a0a2afc37d6ea79b961ff834", kill_on_drop: false }`
[INFO] [stdout] 8ee58f2656b810d2b3f09587a30ba87f4912fe83a0a2afc37d6ea79b961ff834