Dec 07 11:19:30.780 INFO testing hdrhistogram-6.1.1 against try#6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468 for pr-56514
Dec 07 11:19:30.780 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-1/try#6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-1/pr-56514/try#6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468-alt build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Dec 07 11:19:31.169 INFO [stdout] 5312e9b8914ca0a4036a7217ed19bdbae1677e01e3aa1234f37c7792e4b804c6
Dec 07 11:19:31.174 INFO running `"docker" "start" "-a" "5312e9b8914ca0a4036a7217ed19bdbae1677e01e3aa1234f37c7792e4b804c6"`
Dec 07 11:19:31.963 INFO [stderr] usermod: no changes
Dec 07 11:19:32.080 INFO [stderr]    Compiling hdrhistogram v6.1.1 (/source)
Dec 07 11:19:34.460 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 2.48s
Dec 07 11:19:34.472 INFO [stderr] su: No module specific data is present
Dec 07 11:19:35.083 INFO running `"docker" "inspect" "5312e9b8914ca0a4036a7217ed19bdbae1677e01e3aa1234f37c7792e4b804c6"`
Dec 07 11:19:35.344 INFO running `"docker" "rm" "-f" "5312e9b8914ca0a4036a7217ed19bdbae1677e01e3aa1234f37c7792e4b804c6"`
Dec 07 11:19:35.604 INFO [stdout] 5312e9b8914ca0a4036a7217ed19bdbae1677e01e3aa1234f37c7792e4b804c6
Dec 07 11:19:35.612 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-1/try#6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-1/pr-56514/try#6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468-alt test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Dec 07 11:19:35.960 INFO [stdout] e296a4b4d4902128a9600e76ef55f2f78c7e62a0382b74a5652db9951a2c41fd
Dec 07 11:19:35.962 INFO running `"docker" "start" "-a" "e296a4b4d4902128a9600e76ef55f2f78c7e62a0382b74a5652db9951a2c41fd"`
Dec 07 11:19:37.191 INFO [stderr] usermod: no changes
Dec 07 11:19:37.460 INFO [stderr]    Compiling hdrhistogram v6.1.1 (/source)
Dec 07 11:20:01.496 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 24.26s
Dec 07 11:20:01.508 INFO [stderr] su: No module specific data is present
Dec 07 11:20:02.102 INFO running `"docker" "inspect" "e296a4b4d4902128a9600e76ef55f2f78c7e62a0382b74a5652db9951a2c41fd"`
Dec 07 11:20:02.317 INFO running `"docker" "rm" "-f" "e296a4b4d4902128a9600e76ef55f2f78c7e62a0382b74a5652db9951a2c41fd"`
Dec 07 11:20:02.538 INFO [stdout] e296a4b4d4902128a9600e76ef55f2f78c7e62a0382b74a5652db9951a2c41fd
Dec 07 11:20:02.544 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-1/try#6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-1/pr-56514/try#6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +6eb0fd3ac58f9b16bddb9924a17c3b6c156aa468-alt test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Dec 07 11:20:03.048 INFO [stdout] daba71f2d64186fb75fe23034cd037bb793c14bb8c391f1c530b32a952b7dcbe
Dec 07 11:20:03.050 INFO running `"docker" "start" "-a" "daba71f2d64186fb75fe23034cd037bb793c14bb8c391f1c530b32a952b7dcbe"`
Dec 07 11:20:05.195 INFO [stderr] usermod: no changes
Dec 07 11:20:05.336 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.11s
Dec 07 11:20:05.348 INFO [stderr]      Running /target/debug/deps/hdrhistogram-77dfe25315a86211
Dec 07 11:20:05.351 INFO [stdout] 
Dec 07 11:20:05.351 INFO [stdout] running 160 tests
Dec 07 11:20:05.356 INFO [stdout] test serialization::interval_log::tests::iter_with_ignored_prefix ... ok
Dec 07 11:20:05.356 INFO [stdout] test serialization::interval_log::tests::iter_without_ignored_prefix ... ok
Dec 07 11:20:05.356 INFO [stdout] test serialization::interval_log::tests::parse_comment ... ok
Dec 07 11:20:05.356 INFO [stdout] test serialization::interval_log::tests::parse_base_time ... ok
Dec 07 11:20:05.356 INFO [stdout] test serialization::interval_log::tests::iter_all_ignored_empty_iter ... ok
Dec 07 11:20:05.360 INFO [stdout] test serialization::interval_log::tests::iter_multiple_entrties_with_interleaved_ignored ... ok
Dec 07 11:20:05.360 INFO [stdout] test serialization::interval_log::tests::parse_duration_scale_ns ... ok
Dec 07 11:20:05.360 INFO [stdout] test serialization::interval_log::tests::parse_interval_hist_no_tag ... ok
Dec 07 11:20:05.360 INFO [stdout] test serialization::interval_log::tests::parse_duration_too_many_ns ... ok
Dec 07 11:20:05.360 INFO [stdout] test serialization::interval_log::tests::parse_legend ... ok
Dec 07 11:20:05.360 INFO [stdout] test serialization::interval_log::tests::parse_interval_hist_with_tag ... ok
Dec 07 11:20:05.370 INFO [stdout] test serialization::interval_log::tests::parse_duration_full_ns ... ok
Dec 07 11:20:05.372 INFO [stdout] test serialization::interval_log::tests::write_header_comment ... ok
Dec 07 11:20:05.372 INFO [stdout] test serialization::interval_log::tests::write_comment_newline_wraps ... ok
Dec 07 11:20:05.372 INFO [stdout] test serialization::interval_log::tests::write_header_then_interval_comment ... ok
Dec 07 11:20:05.375 INFO [stdout] test serialization::interval_log::tests::parse_start_time_with_human_date ... ok
Dec 07 11:20:05.375 INFO [stdout] test serialization::interval_log::tests::write_base_time ... ok
Dec 07 11:20:05.375 INFO [stdout] test serialization::interval_log::tests::parse_start_time_without_human_date ... ok
Dec 07 11:20:05.375 INFO [stdout] test serialization::interval_log::tests::write_comment_control_characters_still_parseable ... ok
Dec 07 11:20:05.375 INFO [stdout] test serialization::interval_log::tests::write_start_time ... ok
Dec 07 11:20:05.378 INFO [stdout] test serialization::tests::encode_counts_all_zeros ... ok
Dec 07 11:20:05.380 INFO [stdout] test serialization::interval_log::tests::write_headers_multiple_times_only_last_is_used ... ok
Dec 07 11:20:05.383 INFO [stdout] test serialization::tests::rand_varint::largest_number_in_7_bit_chunk_correct ... ok
Dec 07 11:20:05.384 INFO [stdout] test serialization::tests::encode_counts_last_count_incremented ... ok
Dec 07 11:20:05.384 INFO [stdout] test serialization::tests::encode_counts_count_too_big ... ok
Dec 07 11:20:05.386 INFO [stdout] test serialization::tests::serialize_roundtrip_1_count_for_every_value_1_bucket ... ok
Dec 07 11:20:05.405 INFO [stdout] test serialization::interval_log::tests::write_interval_histo_no_tag ... ok
Dec 07 11:20:05.405 INFO [stdout] test serialization::interval_log::tests::write_interval_histo_with_tag ... ok
Dec 07 11:20:05.405 INFO [stdout] test serialization::tests::encode_counts_first_and_last_count_incremented ... ok
Dec 07 11:20:05.405 INFO [stdout] test serialization::tests::serialize_all_zeros ... ok
Dec 07 11:20:05.405 INFO [stdout] test serialization::tests::encode_counts_first_count_incremented ... ok
Dec 07 11:20:05.405 INFO [stdout] test serialization::tests::serialize_roundtrip_all_zeros ... ok
Dec 07 11:20:05.406 INFO [stdout] test serialization::tests::serialize_roundtrip_1_count_for_every_value_2_buckets ... ok
Dec 07 11:20:08.880 INFO [stdout] test serialization::interval_log::tests::duration_fp_roundtrip_accuracy ... ok
Dec 07 11:20:19.990 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_u64 ... ok
Dec 07 11:20:19.990 INFO [stdout] test serialization::tests::varint_read_u64_max ... ok
Dec 07 11:20:19.990 INFO [stdout] test serialization::tests::varint_read_u64_zero ... ok
Dec 07 11:20:19.990 INFO [stdout] test serialization::tests::varint_write_3_bit_value ... ok
Dec 07 11:20:20.004 INFO [stdout] test serialization::tests::varint_write_7_bit_value ... ok
Dec 07 11:20:20.024 INFO [stdout] test serialization::tests::varint_write_9_bit_value ... ok
Dec 07 11:20:20.852 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_u32 ... ok
Dec 07 11:20:21.031 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_2_byte ... ok
Dec 07 11:20:21.136 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_1_byte ... ok
Dec 07 11:20:21.644 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_4_byte ... ok
Dec 07 11:20:21.888 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_5_byte ... ok
Dec 07 11:20:21.973 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_3_byte ... ok
Dec 07 11:20:22.604 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_6_byte ... ok
Dec 07 11:20:23.624 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_8_byte ... ok
Dec 07 11:20:23.640 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_7_byte ... ok
Dec 07 11:20:24.005 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_1_byte ... ok
Dec 07 11:20:24.321 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_2_byte ... ok
Dec 07 11:20:24.365 INFO [stdout] test serialization::tests::varint_write_read_roundtrip_rand_9_byte ... ok
Dec 07 11:20:24.809 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_4_byte ... ok
Dec 07 11:20:24.833 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_deflate_u16 ... ok
Dec 07 11:20:24.958 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_3_byte ... ok
Dec 07 11:20:25.372 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_5_byte ... ok
Dec 07 11:20:25.741 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_7_byte ... ok
Dec 07 11:20:26.096 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_6_byte ... ok
Dec 07 11:20:26.104 INFO [stdout] test serialization::tests::varint_write_u64_max ... ok
Dec 07 11:20:26.108 INFO [stdout] test serialization::tests::zig_zag_decode_0 ... ok
Dec 07 11:20:26.136 INFO [stdout] test serialization::tests::zig_zag_decode_1 ... ok
Dec 07 11:20:26.144 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_9_byte ... ok
Dec 07 11:20:26.152 INFO [stdout] test serialization::tests::zig_zag_decode_u64_max_penultimate_to_i64_max ... ok
Dec 07 11:20:26.172 INFO [stdout] test serialization::tests::zig_zag_decode_u64_max_to_i64_min ... ok
Dec 07 11:20:26.172 INFO [stdout] test serialization::tests::zig_zag_decode_2 ... ok
Dec 07 11:20:26.172 INFO [stdout] test serialization::tests::zig_zag_encode_0 ... ok
Dec 07 11:20:26.172 INFO [stdout] test serialization::tests::zig_zag_encode_1 ... ok
Dec 07 11:20:26.200 INFO [stdout] test serialization::tests::zig_zag_encode_i64_max ... ok
Dec 07 11:20:26.200 INFO [stdout] test serialization::tests::zig_zag_encode_i64_min ... ok
Dec 07 11:20:26.200 INFO [stdout] test serialization::tests::zig_zag_encode_neg_1 ... ok
Dec 07 11:20:26.216 INFO [stdout] test tests::correct_original_min ... ok
Dec 07 11:20:26.272 INFO [stdout] test tests::index_calculation::bucket_for_biggest_value_in_first_bucket ... ok
Dec 07 11:20:26.272 INFO [stdout] test tests::index_calculation::bucket_for_biggest_value_in_second_bucket ... ok
Dec 07 11:20:26.288 INFO [stdout] test tests::index_calculation::bucket_for_smallest_value_in_first_bucket ... ok
Dec 07 11:20:26.296 INFO [stdout] test tests::index_calculation::bucket_for_smallest_value_in_last_bucket ... ok
Dec 07 11:20:26.296 INFO [stdout] test tests::index_calculation::bucket_for_smallest_value_in_second_bucket ... ok
Dec 07 11:20:26.300 INFO [stdout] test tests::index_calculation::bucket_for_smallest_value_in_third_bucket ... ok
Dec 07 11:20:26.308 INFO [stdout] test tests::index_calculation::bucket_for_value_above_biggest_isnt_clamped_at_max_bucket ... ok
Dec 07 11:20:26.308 INFO [stdout] test tests::index_calculation::bucket_for_value_below_smallest_clamps_to_zero ... ok
Dec 07 11:20:26.308 INFO [stdout] test tests::index_calculation::index_for_below_smallest ... ok
Dec 07 11:20:26.308 INFO [stdout] test tests::index_calculation::index_for_first_bucket_first_distinguishable_entry ... ok
Dec 07 11:20:26.320 INFO [stdout] test tests::index_calculation::index_for_first_bucket_first_entry ... ok
Dec 07 11:20:26.356 INFO [stdout] test tests::index_calculation::index_for_first_bucket_last_entry ... ok
Dec 07 11:20:26.364 INFO [stdout] test tests::index_calculation::index_for_second_bucket_first_entry ... ok
Dec 07 11:20:26.364 INFO [stdout] test tests::index_calculation::index_for_second_bucket_last_entry ... ok
Dec 07 11:20:26.364 INFO [stdout] test tests::index_calculation::index_for_second_bucket_last_entry_indistinguishable ... ok
Dec 07 11:20:26.364 INFO [stdout] test tests::index_calculation::index_for_way_past_largest_value_exceeds_length ... ok
Dec 07 11:20:26.372 INFO [stdout] test tests::index_calculation::sub_bucket_for_biggest_value_in_second_bucket ... ok
Dec 07 11:20:26.372 INFO [stdout] test tests::index_calculation::sub_bucket_for_largest_value_in_first_bucket ... ok
Dec 07 11:20:26.372 INFO [stdout] test tests::index_calculation::sub_bucket_for_largest_value_in_first_bucket_unit_magnitude_2 ... ok
Dec 07 11:20:26.400 INFO [stdout] test tests::index_calculation::sub_bucket_for_smaller_than_distinguishable_value_in_first_bucket_unit_magnitude_2 ... ok
Dec 07 11:20:26.400 INFO [stdout] test tests::index_calculation::sub_bucket_for_smallest_distinguishable_value_in_first_bucket ... ok
Dec 07 11:20:26.412 INFO [stdout] test tests::index_calculation::sub_bucket_for_smallest_distinguishable_value_in_first_bucket_unit_magnitude_2 ... ok
Dec 07 11:20:26.420 INFO [stdout] test tests::index_calculation::sub_bucket_for_smallest_value_in_second_bucket ... ok
Dec 07 11:20:26.432 INFO [stdout] test tests::index_calculation::sub_bucket_for_smallest_value_in_second_bucket_unit_magnitude_2 ... ok
Dec 07 11:20:26.456 INFO [stdout] test tests::index_calculation::sub_bucket_for_smallest_value_in_third_bucket ... ok
Dec 07 11:20:26.476 INFO [stdout] test tests::index_calculation::sub_bucket_for_value_above_biggest_still_works ... ok
Dec 07 11:20:26.476 INFO [stdout] test tests::index_calculation::sub_bucket_for_value_below_smallest_clamps_to_zero ... ok
Dec 07 11:20:26.481 INFO [stdout] test tests::index_calculation::sub_bucket_for_zero_value_in_first_bucket ... ok
Dec 07 11:20:26.492 INFO [stdout] test tests::index_calculation::sub_bucket_for_zero_value_in_first_bucket_unit_magnitude_2 ... ok
Dec 07 11:20:26.492 INFO [stdout] test serialization::tests::varint_write_read_slice_roundtrip_rand_8_byte ... ok
Dec 07 11:20:26.493 INFO [stdout] test tests::index_calculation::unit_magnitude_0_index_calculations ... ok
Dec 07 11:20:26.496 INFO [stdout] test tests::index_calculation::unit_magnitude_4_index_calculations ... ok
Dec 07 11:20:26.496 INFO [stdout] test tests::index_calculation::unit_magnitude_53_sub_bucket_magnitude_11_throws ... ok
Dec 07 11:20:26.496 INFO [stdout] test tests::index_calculation::unit_magnitude_55_sub_bucket_magnitude_8_ok ... ok
Dec 07 11:20:26.496 INFO [stdout] test tests::index_calculation::unit_magnitude_62_sub_bucket_magnitude_1_ok ... ok
Dec 07 11:20:26.498 INFO [stdout] test tests::init::init_fields_10m_max_1k_min_middle_precision ... ok
Dec 07 11:20:26.498 INFO [stdout] test tests::init::init_fields_1_bucket_medium_precision ... ok
Dec 07 11:20:26.526 INFO [stdout] test tests::index_calculation::unit_magnitude_52_sub_bucket_magnitude_11_index_calculations ... ok
Dec 07 11:20:26.526 INFO [stdout] test tests::init::init_fields_max_value_0_precision_increased_min_value ... ok
Dec 07 11:20:26.540 INFO [stdout] test tests::init::init_fields_max_value_0_precision_most_buckets ... ok
Dec 07 11:20:26.848 INFO [stdout] test serialization::tests::zig_zag_roundtrip_random ... ok
Dec 07 11:20:26.860 INFO [stdout] test tests::init::init_fields_max_value_max_unit_magnitude_0_precision ... ok
Dec 07 11:20:26.968 INFO [stdout] test tests::init::init_fields_max_value_max_unit_magnitude_max_precision ... ok
Dec 07 11:20:26.975 INFO [stdout] test tests::init::init_fields_max_value_medium_precision ... ok
Dec 07 11:20:26.975 INFO [stdout] test tests::init::init_fields_smallest_possible_array ... ok
Dec 07 11:20:26.975 INFO [stdout] test tests::new_err_high_not_double_low ... ok
Dec 07 11:20:27.144 INFO [stdout] test tests::subtract::subtract_after_add ... ok
Dec 07 11:20:27.216 INFO [stdout] test tests::subtract::subtract_subtrahend_values_outside_minuend_range_error ... ok
Dec 07 11:20:27.400 INFO [stdout] test tests::subtract::subtract_to_negative_counts_error ... ok
Dec 07 11:20:27.688 INFO [stdout] test tests::init::init_fields_max_value_max_precision_increased_min_value ... ok
Dec 07 11:20:27.760 INFO [stdout] test tests::subtract::subtract_to_zero_counts ... ok
Dec 07 11:20:28.044 INFO [stdout] test tests::subtract::subtract_values_at_extent_of_minuend_nonzero_count_range_recalculates_same_min_max ... ok
Dec 07 11:20:28.092 INFO [stdout] test tests::subtract::subtract_values_at_extent_of_minuend_zero_count_range_recalculates_min_max ... ok
Dec 07 11:20:29.699 INFO [stdout] test tests::init::init_fields_max_value_max_precision_largest_possible_array ... ok
Dec 07 11:20:29.972 INFO [stdout] test tests::subtract::subtract_values_inside_minuend_range_works ... ok
Dec 07 11:20:30.240 INFO [stdout] test tests::subtract::subtract_values_minuend_saturated_total_recalculates_not_saturated ... ok
Dec 07 11:20:30.368 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_deflate_u8 ... ok
Dec 07 11:20:30.419 INFO [stdout] test tests::subtract::subtract_values_minuend_saturated_total_recalculates_saturated ... ok
Dec 07 11:20:30.688 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_deflate_u64 ... ok
Dec 07 11:20:30.764 INFO [stdout] test tests::subtract::subtract_values_strictly_inside_minuend_range_yields_same_min_max_no_restat ... ok
Dec 07 11:20:30.764 INFO [stdout] test tests::value_calculation::equivalent_range_unit_magnitude_0 ... ok
Dec 07 11:20:30.772 INFO [stdout] test tests::value_calculation::equivalent_range_unit_magnitude_0_max_buckets ... ok
Dec 07 11:20:32.200 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_u16 ... ok
Dec 07 11:20:32.204 INFO [stdout] test tests::value_calculation::equivalent_range_unit_magnitude_0_min_precision_max_buckets ... ok
Dec 07 11:20:32.208 INFO [stdout] test tests::value_calculation::equivalent_range_unit_magnitude_2 ... ok
Dec 07 11:20:32.236 INFO [stdout] test tests::value_calculation::equivalent_range_unit_magnitude_2_max_buckets ... ok
Dec 07 11:20:32.263 INFO [stdout] test tests::value_calculation::equivalent_range_unit_magnitude_0_max_precision_max_buckets ... ok
Dec 07 11:20:32.268 INFO [stdout] test tests::value_calculation::equivalent_range_unit_magnitude_50_max_buckets ... ok
Dec 07 11:20:32.280 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_u8 ... ok
Dec 07 11:20:32.280 INFO [stdout] test tests::value_calculation::highest_equivalent_unit_magnitude_0 ... ok
Dec 07 11:20:32.288 INFO [stdout] test tests::value_calculation::highest_equivalent_unit_magnitude_2 ... ok
Dec 07 11:20:32.304 INFO [stdout] test tests::value_calculation::lowest_equivalent_unit_magnitude_2 ... ok
Dec 07 11:20:32.304 INFO [stdout] test tests::value_calculation::lowest_equivalent_unit_magnitude_0 ... ok
Dec 07 11:20:32.312 INFO [stdout] test tests::value_calculation::next_non_equivalent_unit_magnitude_0 ... ok
Dec 07 11:20:32.312 INFO [stdout] test tests::value_calculation::next_non_equivalent_unit_magnitude_2 ... ok
Dec 07 11:20:32.344 INFO [stdout] test tests::value_calculation::next_non_equivalent_u64_max_value_saturates ... ok
Dec 07 11:20:32.368 INFO [stdout] test tests::value_calculation::highest_equivalent_u64_max_value_saturates ... ok
Dec 07 11:20:32.372 INFO [stdout] test tests::value_calculation::value_for_beyond_histogram_max_still_works ... ok
Dec 07 11:20:32.379 INFO [stdout] test tests::value_calculation::value_for_impossible_index ... ok
Dec 07 11:20:32.379 INFO [stdout] test tests::value_calculation::value_for_unit_magnitude_0 ... ok
Dec 07 11:20:32.380 INFO [stdout] test tests::value_calculation::value_for_unit_magnitude_2 ... ok
Dec 07 11:20:32.384 INFO [stdout] test tests::value_calculation::value_from_loc_unit_magnitude_0 ... ok
Dec 07 11:20:32.392 INFO [stdout] test tests::value_calculation::value_from_loc_unit_magnitude_2 ... ok
Dec 07 11:20:33.916 INFO [stdout] test tests::value_calculation::value_for_at_each_index ... ok
Dec 07 11:20:34.896 INFO [stdout] test serialization::tests::serialize_roundtrip_random_v2_deflate_u32 ... ok
Dec 07 11:20:38.380 INFO [stdout] test tests::subtract::subtract_values_at_minuend_min_recalculates_min_max ... ok
Dec 07 11:20:38.941 INFO [stdout] test tests::subtract::subtract_values_within_bucket_precision_of_of_minuend_max_recalculates_min_max ... ok
Dec 07 11:20:39.640 INFO [stdout] test tests::subtract::subtract_values_at_minuend_max_recalculates_min_max ... ok
Dec 07 11:20:40.304 INFO [stdout] test tests::subtract::subtract_values_within_bucket_precision_of_of_minuend_min_recalculates_min_max ... ok
Dec 07 11:20:40.304 INFO [stdout] 
Dec 07 11:20:40.304 INFO [stdout] test result: ok. 160 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:20:40.304 INFO [stdout] 
Dec 07 11:20:40.308 INFO [stderr]      Running /target/debug/deps/auto_resize-d3c5e5f5bf7c361c
Dec 07 11:20:40.308 INFO [stdout] 
Dec 07 11:20:40.308 INFO [stdout] running 4 tests
Dec 07 11:20:40.313 INFO [stdout] test autosizing_add ... ok
Dec 07 11:20:40.344 INFO [stdout] test histogram_autosizing_edges ... ok
Dec 07 11:20:40.344 INFO [stdout] test histogram_autosizing ... ok
Dec 07 11:20:43.286 INFO [stdout] test autosizing_across_continuous_range ... ok
Dec 07 11:20:43.286 INFO [stderr]      Running /target/debug/deps/data_access-2a4cfce9b25ff857
Dec 07 11:20:43.286 INFO [stdout] 
Dec 07 11:20:43.286 INFO [stdout] test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:20:43.286 INFO [stdout] 
Dec 07 11:20:43.292 INFO [stdout] 
Dec 07 11:20:43.292 INFO [stdout] running 26 tests
Dec 07 11:20:43.328 INFO [stdout] test count_at_beyond_max_value ... ok
Dec 07 11:20:43.361 INFO [stdout] test count_between_saturates ... ok
Dec 07 11:20:43.369 INFO [stdout] test count_between_low_and_high_beyond_max ... ok
Dec 07 11:20:43.396 INFO [stdout] test count_between_high_beyond_max ... ok
Dec 07 11:20:43.524 INFO [stdout] test count_at ... ok
Dec 07 11:20:43.602 INFO [stdout] test count_between ... ok
Dec 07 11:20:43.615 INFO [stdout] test get_max_value ... ok
Dec 07 11:20:43.640 INFO [stdout] test iter_recorded ... ok
Dec 07 11:20:43.640 INFO [stdout] test get_min_value ... ok
Dec 07 11:20:43.656 INFO [stdout] test linear_iter_steps ... ok
Dec 07 11:20:43.682 INFO [stdout] test get_mean ... ok
Dec 07 11:20:43.696 INFO [stdout] test iter_log ... ok
Dec 07 11:20:43.716 INFO [stdout] test quantile_below_value_beyond_max ... ok
Dec 07 11:20:43.718 INFO [stdout] test quantile_atorbelow ... ok
Dec 07 11:20:43.721 INFO [stdout] test get_stdev ... ok
Dec 07 11:20:43.725 INFO [stdout] test quantile_below_saturates ... ok
Dec 07 11:20:43.786 INFO [stdout] test iter_all ... ok
Dec 07 11:20:43.796 INFO [stdout] test total_count_exceeds_bucket_type ... ok
Dec 07 11:20:43.800 INFO [stdout] test linear_iter_raw ... ok
Dec 07 11:20:43.924 INFO [stdout] test total_count ... ok
Dec 07 11:20:43.976 INFO [stdout] test quantiles ... ok
Dec 07 11:20:43.976 INFO [stdout] test scaling_equivalence ... ok
Dec 07 11:20:43.992 INFO [stdout] test value_duplication ... ok
Dec 07 11:20:44.004 INFO [stdout] test linear_iter_corrected ... ok
Dec 07 11:20:44.112 INFO [stdout] test quantile_iter ... ok
Dec 07 11:20:44.558 INFO [stdout] test large_quantile ... ok
Dec 07 11:20:44.558 INFO [stdout] 
Dec 07 11:20:44.558 INFO [stdout] test result: ok. 26 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:20:44.558 INFO [stdout] 
Dec 07 11:20:44.560 INFO [stdout] 
Dec 07 11:20:44.560 INFO [stderr]      Running /target/debug/deps/histogram-9d5e4eaa4fe17c0d
Dec 07 11:20:44.560 INFO [stdout] running 37 tests
Dec 07 11:20:44.560 INFO [stdout] test construction_arg_ranges ... ok
Dec 07 11:20:44.564 INFO [stdout] test median_equivalent ... ok
Dec 07 11:20:44.568 INFO [stdout] test highest_equivalent ... ok
Dec 07 11:20:44.572 INFO [stdout] test equivalent_range ... ok
Dec 07 11:20:44.597 INFO [stdout] test empty_histogram ... ok
Dec 07 11:20:44.624 INFO [stdout] test lowest_equivalent ... ok
Dec 07 11:20:44.625 INFO [stdout] test construction_arg_gets ... ok
Dec 07 11:20:44.628 INFO [stdout] test record ... ok
Dec 07 11:20:44.687 INFO [stdout] test record_past_trackable_max ... ok
Dec 07 11:20:44.724 INFO [stdout] test median_equivalent_doesnt_panic_at_extremes ... ok
Dec 07 11:20:44.764 INFO [stdout] test record_in_interval ... ok
Dec 07 11:20:44.764 INFO [stdout] test saturating_record ... ok
Dec 07 11:20:44.768 INFO [stdout] test scaled_equivalent_range ... ok
Dec 07 11:20:44.780 INFO [stdout] test reset ... ok
Dec 07 11:20:44.780 INFO [stdout] test scaled_lowest_equivalent ... ok
Dec 07 11:20:44.780 INFO [stdout] test add ... ok
Dec 07 11:20:44.808 INFO [stdout] test scaled_median_equivalent ... ok
Dec 07 11:20:44.808 INFO [stdout] test scaled_highest_equivalent ... ok
Dec 07 11:20:44.888 INFO [stdout] test subtract_underflow_guarded_by_per_value_count_check ... ok
Dec 07 11:20:44.933 INFO [stdout] test clone ... ok
Dec 07 11:20:44.956 INFO [stdout] test scaled_clone ... ok
Dec 07 11:20:44.984 INFO [stdout] test total_count_overflow_from_add_same_dimensions_saturates_calculating_other_addend_total ... ok
Dec 07 11:20:45.012 INFO [stdout] test total_count_overflow_from_add_with_resize_saturates ... ok
Dec 07 11:20:45.044 INFO [stdout] test total_count_overflow_from_record_saturates ... ok
Dec 07 11:20:45.100 INFO [stdout] test total_count_overflow_from_add_different_precision_saturates ... ok
Dec 07 11:20:45.104 INFO [stdout] test total_count_overflow_from_add_same_dimensions_saturates_when_added_to_orig_total_count ... ok
Dec 07 11:20:45.149 INFO [stdout] test value_count_overflow_from_add_same_dimensions_saturates ... ok
Dec 07 11:20:45.154 INFO [stdout] test scaled_set_to ... ok
Dec 07 11:20:45.154 INFO [stdout] test value_count_overflow_from_record_autoresize_doesnt_panic_saturates ... ok
Dec 07 11:20:45.163 INFO [stdout] test value_count_overflow_from_record_saturates_u16 ... ok
Dec 07 11:20:45.163 INFO [stdout] test value_count_overflow_from_record_saturates_u64 ... ok
Dec 07 11:20:45.168 INFO [stdout] test set_to ... ok
Dec 07 11:20:45.176 INFO [stdout] test value_count_overflow_from_add_with_resize_to_same_dimensions_saturates ... ok
Dec 07 11:20:45.190 INFO [stdout] test random_write_middle_of_value_range_precision_3_no_panic ... ok
Dec 07 11:20:45.368 INFO [stdout] test value_count_overflow_from_add_different_precision_saturates ... ok
Dec 07 11:20:45.405 INFO [stdout] test random_write_full_value_range_precision_0_no_panic ... ok
Dec 07 11:20:45.969 INFO [stdout] test random_write_full_value_range_precision_5_no_panic ... ok
Dec 07 11:20:45.969 INFO [stdout] 
Dec 07 11:20:45.969 INFO [stdout] test result: ok. 37 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:20:45.969 INFO [stdout] 
Dec 07 11:20:45.970 INFO [stderr]      Running /target/debug/deps/interval_log-db3d236ab44526b2
Dec 07 11:20:45.974 INFO [stdout] 
Dec 07 11:20:45.974 INFO [stdout] running 6 tests
Dec 07 11:20:45.993 INFO [stdout] test tests::parse_interval_log_syntax_error_then_returns_none ... ok
Dec 07 11:20:45.993 INFO [stdout] test tests::parse_sample_tagged_interval_log_interval_count ... ok
Dec 07 11:20:46.016 INFO [stdout] test tests::parse_sample_tagged_interval_log_start_timestamp ... ok
Dec 07 11:20:46.057 INFO [stdout] test tests::parse_sample_tagged_interval_log_interval_metadata ... ok
Dec 07 11:20:46.100 INFO [stdout] test tests::parse_sample_tagged_interval_log_rewrite_identical ... ok
Dec 07 11:20:49.756 INFO [stdout] test tests::write_random_histograms_to_interval_log_then_read ... ok
Dec 07 11:20:49.756 INFO [stdout] 
Dec 07 11:20:49.756 INFO [stdout] test result: ok. 6 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:20:49.756 INFO [stdout] 
Dec 07 11:20:49.759 INFO [stderr]      Running /target/debug/deps/iterators-b9093b343bba52bb
Dec 07 11:20:49.761 INFO [stdout] 
Dec 07 11:20:49.761 INFO [stdout] running 20 tests
Dec 07 11:20:49.771 INFO [stdout] test iter_linear_bucket_values_size_8_all_buckets ... ok
Dec 07 11:20:49.772 INFO [stdout] test iter_all_values_all_buckets_unit_magnitude_2 ... ok
Dec 07 11:20:49.773 INFO [stdout] test iter_logarithmic_bucket_values_min_1_base_2_all_buckets_unit_magnitude_2 ... ok
Dec 07 11:20:49.777 INFO [stdout] test iter_logarithmic_bucket_values_min_4_base_2_all_buckets ... ok
Dec 07 11:20:49.778 INFO [stdout] test iter_quantiles_empty ... ok
Dec 07 11:20:49.781 INFO [stdout] test iter_all_values_all_buckets ... ok
Dec 07 11:20:49.783 INFO [stdout] test iter_linear_count_since_last_iteration_saturates ... ok
Dec 07 11:20:49.785 INFO [stdout] test iter_quantiles_one_value ... ok
Dec 07 11:20:49.785 INFO [stdout] test iter_logarithmic_bucket_values_min_1_base_2_all_buckets ... ok
Dec 07 11:20:49.795 INFO [stdout] test iter_logarithmic_bucket_values_min_1_base_10_all_buckets ... ok
Dec 07 11:20:49.796 INFO [stdout] test iter_quantiles_iterates_to_quantile_10_as_it_reaches_last_bucket ... ok
Dec 07 11:20:49.798 INFO [stdout] test iter_quantiles_smorgasboard ... ok
Dec 07 11:20:49.798 INFO [stdout] test iter_quantiles_iterates_to_end_skips_intermediate_at_final_value ... ok
Dec 07 11:20:49.802 INFO [stdout] test iter_quantiles_saturated_count_before_max_value ... ok
Dec 07 11:20:49.804 INFO [stdout] test iter_recorded_values_all_buckets_unit_magnitude_2 ... ok
Dec 07 11:20:49.808 INFO [stdout] test iter_recorded_values_all_buckets ... ok
Dec 07 11:20:49.817 INFO [stdout] test iter_recorded_saturated_total_count ... ok
Dec 07 11:20:49.828 INFO [stdout] test iter_linear_visits_buckets_wider_than_step_size_multiple_times ... ok
Dec 07 11:20:49.828 INFO [stdout] test iter_linear_visits_buckets_once_when_step_size_equals_bucket_size ... ok
Dec 07 11:20:49.850 INFO [stdout] test iter_recorded_non_saturated_total_count ... ok
Dec 07 11:20:49.850 INFO [stdout] 
Dec 07 11:20:49.850 INFO [stdout] test result: ok. 20 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:20:49.850 INFO [stdout] 
Dec 07 11:20:49.852 INFO [stderr]      Running /target/debug/deps/quantile-5176b686cdccfc8f
Dec 07 11:20:49.855 INFO [stdout] 
Dec 07 11:20:49.855 INFO [stdout] running 10 tests
Dec 07 11:20:49.881 INFO [stdout] test value_at_quantile_internal_count_exceeds_bucket_type ... ok
Dec 07 11:20:49.924 INFO [stdout] test value_at_quantile_20k ... ok
Dec 07 11:20:49.935 INFO [stdout] test value_at_quantile_2_values ... ok
Dec 07 11:20:49.976 INFO [stdout] test value_at_quantile_5_values ... ok
Dec 07 11:20:50.043 INFO [stdout] test value_at_quantile_large_numbers ... ok
Dec 07 11:20:52.124 INFO [stdout] test value_at_quantile_matches_quantile_iter_sequence_values ... ok
Dec 07 11:20:59.436 INFO [stdout] test value_at_quantile_matches_quantile_at_each_value_sequence_values ... ok
Dec 07 11:21:20.924 INFO [stdout] test value_at_quantile_matches_quantile_iter_random_values ... ok
Dec 07 11:21:26.583 INFO [stdout] test value_at_quantile_matches_random_quantile_random_values ... ok
Dec 07 11:21:47.082 INFO [stdout] test value_at_quantile_matches_quantile_at_each_value_random_values ... ok
Dec 07 11:21:47.082 INFO [stdout] 
Dec 07 11:21:47.082 INFO [stdout] test result: ok. 10 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:21:47.082 INFO [stdout] 
Dec 07 11:21:47.085 INFO [stderr]      Running /target/debug/deps/serialization-0e072b290b6ec6ca
Dec 07 11:21:47.085 INFO [stdout] 
Dec 07 11:21:47.085 INFO [stdout] running 4 tests
Dec 07 11:21:47.154 INFO [stdout] test tests::total_count_overflow_from_deserialize_saturates ... ok
Dec 07 11:21:47.464 INFO [stdout] test tests::deserialize_no_compression_matches_java ... ok
Dec 07 11:21:47.624 INFO [stdout] test tests::deserialize_compression_matches_java ... ok
Dec 07 11:21:47.657 INFO [stdout] test tests::serialize_no_compression_matches_java_impl ... ok
Dec 07 11:21:47.657 INFO [stdout] 
Dec 07 11:21:47.657 INFO [stdout] test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:21:47.657 INFO [stdout] 
Dec 07 11:21:47.657 INFO [stderr]    Doc-tests hdrhistogram
Dec 07 11:21:49.267 INFO [stdout] 
Dec 07 11:21:49.267 INFO [stdout] running 15 tests
Dec 07 11:22:01.888 INFO [stdout] test src/lib.rs - Histogram<T>::iter_log (line 1093) ... ok
Dec 07 11:22:01.992 INFO [stdout] test src/lib.rs -  (line 71) ... ok
Dec 07 11:22:04.668 INFO [stdout] test src/lib.rs -  (line 97) ... ok
Dec 07 11:22:05.812 INFO [stdout] test src/lib.rs - Histogram<T>::iter_quantiles (line 977) ... ok
Dec 07 11:22:06.352 INFO [stdout] test src/lib.rs - Histogram<T>::iter_linear (line 1035) ... ok
Dec 07 11:22:06.984 INFO [stdout] test src/lib.rs - Histogram<T>::iter_all (line 1170) ... ok
Dec 07 11:22:07.116 INFO [stdout] test src/lib.rs - Histogram<T>::iter_recorded (line 1131) ... ok
Dec 07 11:22:07.568 INFO [stdout] test src/lib.rs -  (line 110) ... ok
Dec 07 11:22:14.685 INFO [stdout] test src/serialization/interval_log/mod.rs - serialization::interval_log (line 175) ... ok
Dec 07 11:22:15.616 INFO [stdout] test src/serialization/interval_log/mod.rs - serialization::interval_log::IntervalLogWriter (line 339) ... ok
Dec 07 11:22:15.829 INFO [stdout] test src/serialization/interval_log/mod.rs - serialization::interval_log (line 145) ... ok
Dec 07 11:22:16.613 INFO [stdout] test src/serialization/mod.rs - serialization (line 75) ... ok
Dec 07 11:22:17.188 INFO [stdout] test src/serialization/interval_log/mod.rs - serialization::interval_log (line 122) ... ok
Dec 07 11:22:18.584 INFO [stdout] test src/serialization/mod.rs - serialization (line 119) ... ok
Dec 07 11:22:18.794 INFO [stdout] test src/serialization/mod.rs - serialization (line 134) ... ok
Dec 07 11:22:18.794 INFO [stdout] 
Dec 07 11:22:18.794 INFO [stdout] test result: ok. 15 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 07 11:22:18.794 INFO [stdout] 
Dec 07 11:22:18.825 INFO [stderr] su: No module specific data is present
Dec 07 11:22:19.736 INFO running `"docker" "inspect" "daba71f2d64186fb75fe23034cd037bb793c14bb8c391f1c530b32a952b7dcbe"`
Dec 07 11:22:19.990 INFO running `"docker" "rm" "-f" "daba71f2d64186fb75fe23034cd037bb793c14bb8c391f1c530b32a952b7dcbe"`
Dec 07 11:22:20.284 INFO [stdout] daba71f2d64186fb75fe23034cd037bb793c14bb8c391f1c530b32a952b7dcbe