[INFO] fetching crate webrtc-ice 0.4.0... [INFO] testing webrtc-ice-0.4.0 against 1.55.0 for beta-1.56-1 [INFO] extracting crate webrtc-ice 0.4.0 into /workspace/builds/worker-2/source [INFO] validating manifest of crates.io crate webrtc-ice 0.4.0 on toolchain 1.55.0 [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+1.55.0" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking crates.io crate webrtc-ice 0.4.0 [INFO] removed 0 missing examples [INFO] finished tweaking crates.io crate webrtc-ice 0.4.0 [INFO] tweaked toml for crates.io crate webrtc-ice 0.4.0 written to /workspace/builds/worker-2/source/Cargo.toml [INFO] crate crates.io crate webrtc-ice 0.4.0 already has a lockfile, it will not be regenerated [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+1.55.0" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/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:a89201d6b5b9fd45c15d5952ece0a0129e7e80cb26ec023fd59cf09bc26f1604" "/opt/rustwide/cargo-home/bin/cargo" "+1.55.0" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] 7f62f611f7b01e6f52f630e70f19e72a3acab5b1b4ea812f0b0e3c1f330dae9c [INFO] running `Command { std: "docker" "start" "-a" "7f62f611f7b01e6f52f630e70f19e72a3acab5b1b4ea812f0b0e3c1f330dae9c", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "7f62f611f7b01e6f52f630e70f19e72a3acab5b1b4ea812f0b0e3c1f330dae9c", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "7f62f611f7b01e6f52f630e70f19e72a3acab5b1b4ea812f0b0e3c1f330dae9c", kill_on_drop: false }` [INFO] [stdout] 7f62f611f7b01e6f52f630e70f19e72a3acab5b1b4ea812f0b0e3c1f330dae9c [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/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:a89201d6b5b9fd45c15d5952ece0a0129e7e80cb26ec023fd59cf09bc26f1604" "/opt/rustwide/cargo-home/bin/cargo" "+1.55.0" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] f0c4ca4e6cdf976d17fd202a5f16e33114aaecd04e45d5201bb64751f63e11f7 [INFO] running `Command { std: "docker" "start" "-a" "f0c4ca4e6cdf976d17fd202a5f16e33114aaecd04e45d5201bb64751f63e11f7", kill_on_drop: false }` [INFO] [stderr] Compiling ipnet v2.3.1 [INFO] [stderr] Compiling crc-catalog v1.1.1 [INFO] [stderr] Compiling subtle v2.4.1 [INFO] [stderr] Compiling webrtc-util v0.4.2 [INFO] [stderr] Compiling waitgroup v0.1.2 [INFO] [stderr] Compiling getrandom v0.2.3 [INFO] [stderr] Compiling parking_lot_core v0.8.5 [INFO] [stderr] Compiling num_cpus v1.13.0 [INFO] [stderr] Compiling mio v0.7.13 [INFO] [stderr] Compiling signal-hook-registry v1.4.0 [INFO] [stderr] Compiling ring v0.16.20 [INFO] [stderr] Compiling socket2 v0.4.1 [INFO] [stderr] Compiling nix v0.22.1 [INFO] [stderr] Compiling crc v2.0.0 [INFO] [stderr] Compiling rand_core v0.6.3 [INFO] [stderr] Compiling uuid v0.8.2 [INFO] [stderr] Compiling parking_lot v0.11.2 [INFO] [stderr] Compiling rand_chacha v0.3.1 [INFO] [stderr] Compiling tokio v1.11.0 [INFO] [stderr] Compiling rand v0.8.4 [INFO] [stderr] Compiling stun v0.3.3 [INFO] [stderr] Compiling webrtc-mdns v0.3.3 [INFO] [stderr] Compiling turn v0.3.4 [INFO] [stderr] Compiling webrtc-ice v0.4.0 (/opt/rustwide/workdir) [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 30.55s [INFO] running `Command { std: "docker" "inspect" "f0c4ca4e6cdf976d17fd202a5f16e33114aaecd04e45d5201bb64751f63e11f7", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "f0c4ca4e6cdf976d17fd202a5f16e33114aaecd04e45d5201bb64751f63e11f7", kill_on_drop: false }` [INFO] [stdout] f0c4ca4e6cdf976d17fd202a5f16e33114aaecd04e45d5201bb64751f63e11f7 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/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:a89201d6b5b9fd45c15d5952ece0a0129e7e80cb26ec023fd59cf09bc26f1604" "/opt/rustwide/cargo-home/bin/cargo" "+1.55.0" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 43e2378a7057a8cbbb0060e6e20abd433c75ddfd13f4f6d2bf3445e30547f023 [INFO] running `Command { std: "docker" "start" "-a" "43e2378a7057a8cbbb0060e6e20abd433c75ddfd13f4f6d2bf3445e30547f023", kill_on_drop: false }` [INFO] [stderr] Compiling futures-task v0.3.17 [INFO] [stderr] Compiling futures-channel v0.3.17 [INFO] [stderr] Compiling httpdate v1.0.1 [INFO] [stderr] Compiling tower-service v0.3.1 [INFO] [stderr] Compiling indexmap v1.7.0 [INFO] [stderr] Compiling futures-util v0.3.17 [INFO] [stderr] Compiling tracing v0.1.26 [INFO] [stderr] Compiling time v0.1.44 [INFO] [stderr] Compiling http-body v0.4.3 [INFO] [stderr] Compiling want v0.3.0 [INFO] [stderr] Compiling clap v2.33.3 [INFO] [stderr] Compiling async-stream-impl v0.3.2 [INFO] [stderr] Compiling env_logger v0.8.4 [INFO] [stderr] Compiling tokio-util v0.6.8 [INFO] [stderr] Compiling tokio-stream v0.1.7 [INFO] [stderr] Compiling chrono v0.4.19 [INFO] [stderr] Compiling async-stream v0.3.2 [INFO] [stderr] Compiling tokio-test v0.4.2 [INFO] [stderr] Compiling h2 v0.3.4 [INFO] [stderr] Compiling hyper v0.14.12 [INFO] [stderr] Compiling webrtc-ice v0.4.0 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 57.96s [INFO] running `Command { std: "docker" "inspect" "43e2378a7057a8cbbb0060e6e20abd433c75ddfd13f4f6d2bf3445e30547f023", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "43e2378a7057a8cbbb0060e6e20abd433c75ddfd13f4f6d2bf3445e30547f023", kill_on_drop: false }` [INFO] [stdout] 43e2378a7057a8cbbb0060e6e20abd433c75ddfd13f4f6d2bf3445e30547f023 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-2/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:a89201d6b5b9fd45c15d5952ece0a0129e7e80cb26ec023fd59cf09bc26f1604" "/opt/rustwide/cargo-home/bin/cargo" "+1.55.0" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 5fb2f6bc2db594e6ddcdf7de985cb0b80a2221899103fe6ae60250b675d96c44 [INFO] running `Command { std: "docker" "start" "-a" "5fb2f6bc2db594e6ddcdf7de985cb0b80a2221899103fe6ae60250b675d96c44", kill_on_drop: false }` [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.15s [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/webrtc_ice-4aab05185fae1b23) [INFO] [stdout] [INFO] [stdout] running 80 tests [INFO] [stdout] test agent::agent_gather_test::test_vnet_gather_dynamic_ip_address ... ok [INFO] [stdout] test agent::agent_gather_test::test_vnet_gather_no_local_ip_address ... ok [INFO] [stdout] test agent::agent_gather_test::test_vnet_gather_with_interface_filter ... ok [INFO] [stdout] test agent::agent_test::test_agent_restart_during_gather ... ok [INFO] [stdout] test agent::agent_gather_test::test_vnet_gather_with_nat_1to1_as_srflx_candidates ... ok [INFO] [stdout] test agent::agent_gather_test::test_vnet_gather_with_nat_1to1_as_host_candidates ... ok [INFO] [stdout] test agent::agent_test::test_candidate_pair_stats ... ok [INFO] [stdout] test agent::agent_test::test_agent_credentials ... ok [INFO] [stdout] test agent::agent_gather_test::test_vnet_gather_listen_udp ... ok [INFO] [stdout] test agent::agent_gather_test::test_vnet_gather_turn_connection_leak ... ok [INFO] [stdout] test agent::agent_test::test_binding_request_timeout ... ok [INFO] [stdout] test agent::agent_test::test_agent_restart_when_closed ... ok [INFO] [stdout] test agent::agent_test::test_handle_peer_reflexive_unknown_remote ... ok [INFO] [stdout] test agent::agent_test::test_handle_peer_reflexive_udp_pflx_candidate ... ok [INFO] [stdout] test agent::agent_test::test_connectivity_on_startup ... ok [INFO] [stdout] test agent::agent_test::test_invalid_gather ... ok [INFO] [stdout] test agent::agent_test::test_local_candidate_stats ... ok [INFO] [stdout] test agent::agent_test::test_get_remote_credentials ... ok [INFO] [stdout] test candidate::candidate_test::test_candidate_foundation ... ok [INFO] [stdout] test candidate::candidate_test::test_candidate_last_received ... ok [INFO] [stdout] test candidate::candidate_test::test_candidate_last_sent ... ok [INFO] [stdout] test candidate::candidate_test::test_candidate_priority ... ok [INFO] [stdout] test control::control_test::test_control_get_from ... ok [INFO] [stdout] test control::control_test::test_controlled_get_from ... ok [INFO] [stdout] test control::control_test::test_controlling_get_from ... ok [INFO] [stdout] test external_ip_mapper::external_ip_mapper_test::test_external_ip_mapper_find_external_ip_with_empty_map ... ok [INFO] [stdout] test external_ip_mapper::external_ip_mapper_test::test_external_ip_mapper_find_external_ip_with_explicit_local_ip ... ok [INFO] [stdout] test external_ip_mapper::external_ip_mapper_test::test_external_ip_mapper_find_external_ip_without_explicit_local_ip ... ok [INFO] [stdout] test external_ip_mapper::external_ip_mapper_test::test_external_ip_mapper_new_external_ip_mapper ... ok [INFO] [stdout] test external_ip_mapper::external_ip_mapper_test::test_external_ip_mapper_new_external_ip_mapper_with_explicit_local_ip ... ok [INFO] [stdout] test external_ip_mapper::external_ip_mapper_test::test_external_ip_mapper_new_external_ip_mapper_with_implicit_local_ip ... ok [INFO] [stdout] test external_ip_mapper::external_ip_mapper_test::test_external_ip_mapper_validate_ip_string ... ok [INFO] [stdout] test mdns::mdns_test::test_generate_multicast_dnsname ... ok [INFO] [stdout] test candidate::candidate_test::test_candidate_marshal ... ok [INFO] [stdout] test candidate::candidate_pair_test::test_candidate_pair_priority ... ok [INFO] [stdout] test agent::agent_test::test_pair_priority ... ok [INFO] [stdout] test candidate::candidate_pair_test::test_candidate_pair_equality ... ok [INFO] [stdout] test mdns::mdns_test::test_multicast_dns_static_host_name ... ok [INFO] [stdout] test network_type::network_type_test::test_network_type_is_udp ... ok [INFO] [stdout] test agent::agent_test::test_on_selected_candidate_pair_change ... ok [INFO] [stdout] test agent::agent_test::test_inbound_validity ... ok [INFO] [stdout] test network_type::network_type_test::test_network_type_is_tcp ... ok [INFO] [stdout] test network_type::network_type_test::test_network_type_parsing_failure ... ok [INFO] [stdout] test agent::agent_test::test_init_ext_ip_mapping ... ok [INFO] [stdout] test network_type::network_type_test::test_network_type_parsing_success ... ok [INFO] [stdout] test state::state_test::test_connected_state_string ... ok [INFO] [stdout] test priority::priority_test::test_priority_get_from ... ok [INFO] [stdout] test tcp_type::tcp_type_test::test_tcp_type ... ok [INFO] [stdout] test state::state_test::test_gathering_state_string ... ok [INFO] [stdout] test url::url_test::test_parse_url_success ... ok [INFO] [stdout] test use_candidate::use_candidate_test::test_use_candidate_attr_add_to ... ok [INFO] [stdout] test url::url_test::test_parse_url_failure ... ok [INFO] [stdout] test agent::agent_test::test_invalid_agent_starts ... ok [INFO] [stdout] test agent::agent_vnet_test::test_write_use_valid_pair ... ok [INFO] [stdout] test agent::agent_test::test_pair_search ... ok [INFO] [stdout] test rand::rand_test::test_random_generator_collision ... ok [INFO] [stdout] test util::util_test::test_local_interfaces ... ok [INFO] [stdout] test agent::agent_test::test_remote_candidate_stats ... ok [INFO] [stdout] test candidate::candidate_server_reflexive_test::test_server_reflexive_only_connection ... ok [INFO] [stdout] test agent::agent_test::test_connectivity_lite ... ok [INFO] [stdout] test agent::agent_transport_test::test_remote_local_addr ... ok [INFO] [stdout] test agent::agent_vnet_test::test_connectivity_simple_vnet_full_cone_nats_on_both_ends ... ok [INFO] [stdout] test agent::agent_vnet_test::test_connectivity_vnet_1to1_nat_with_host_candidate_vs_symmetric_nats ... ok [INFO] [stdout] test agent::agent_vnet_test::test_disconnected_to_connected ... ok [INFO] [stdout] test agent::agent_vnet_test::test_connectivity_vnet_1to1_nat_with_srflx_candidate_vs_symmetric_nats ... ok [INFO] [stdout] test agent::agent_test::test_connection_state_connecting_to_failed ... ok [INFO] [stdout] test agent::agent_vnet_test::test_connectivity_vnet_full_cone_nats_on_both_ends ... ok [INFO] [stdout] test candidate::candidate_relay_test::test_relay_only_connection ... ok [INFO] [stdout] test agent::agent_vnet_test::test_connectivity_vnet_symmetric_nats_on_both_ends ... ok [INFO] [stdout] test agent::agent_test::test_agent_restart_both_side has been running for over 60 seconds [INFO] [stdout] test agent::agent_test::test_agent_restart_one_side has been running for over 60 seconds [INFO] [stdout] test agent::agent_test::test_close_in_connection_state_callback has been running for over 60 seconds [INFO] [stdout] test agent::agent_test::test_connection_state_callback has been running for over 60 seconds [INFO] [stdout] test agent::agent_test::test_connection_state_failed_delete_all_candidates has been running for over 60 seconds [INFO] [stdout] test agent::agent_test::test_lite_lifecycle has been running for over 60 seconds [INFO] [stdout] test agent::agent_test::test_run_task_in_connection_state_callback has been running for over 60 seconds [INFO] [stdout] test agent::agent_test::test_run_task_in_selected_candidate_pair_change_callback has been running for over 60 seconds [INFO] [stdout] test agent::agent_transport_test::test_conn_stats has been running for over 60 seconds [INFO] [stdout] test mdns::mdns_test::test_multicast_dns_mixed_connection has been running for over 60 seconds [INFO] [stdout] test mdns::mdns_test::test_multicast_dns_only_connection has been running for over 60 seconds [ERROR] error running command: no output for 300 seconds [INFO] running `Command { std: "docker" "inspect" "5fb2f6bc2db594e6ddcdf7de985cb0b80a2221899103fe6ae60250b675d96c44", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "5fb2f6bc2db594e6ddcdf7de985cb0b80a2221899103fe6ae60250b675d96c44", kill_on_drop: false }` [INFO] [stdout] 5fb2f6bc2db594e6ddcdf7de985cb0b80a2221899103fe6ae60250b675d96c44