JUnit version 4.13.2
.02:03:49.737 [DEBUG - main] (RandomUtils.java:49) Using random seed: 1786500229729
02:03:49.782 [INFO - main] (RetryRule.java:138) Creating RetryStatement with result reporter and retry count of 0 (no retries)
02:03:49.855 [INFO - main] (KuduTestHarness.java:155) Creating a new MiniKuduCluster...
02:03:49.870 [INFO - main] (TempDirUtils.java:71) Using the temp directory defined by TEST_TMPDIR: /tmp/dist-test-taskE13Vx3/test-tmp
02:03:49.877 [INFO - main] (KuduBinaryLocator.java:83) Using Kudu binary directory specified by system property 'kuduBinDir': ../../../build/tsan/bin
02:03:49.881 [INFO - main] (MiniKuduCluster.java:217) Starting process: [/tmp/dist-test-taskE13Vx3/java/build/dist-test/../../../build/tsan/bin/kudu, test, mini_cluster, --serialization=pb]
02:03:50.072 [DEBUG - main] (MiniKuduCluster.java:185) Request: create_cluster {
  num_masters: 3
  num_tservers: 3
  enable_kerberos: false
  cluster_root: "/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674"
  hms_mode: NONE
  mini_kdc_options {
  }
  principal: "kudu"
  mini_oidc_options {
  }
}

02:03:50.263 [DEBUG - main] (MiniKuduCluster.java:195) Response: 
02:03:50.264 [DEBUG - main] (MiniKuduCluster.java:185) Request: start_cluster {
}

02:03:50.269 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.269042 25980 mini_oidc.cc:150] Starting JWKS server
02:03:50.273 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.272748 25980 webserver.cc:533] Webserver started at http://127.0.0.1:38149/ using document root <none> and password file <none>
02:03:50.273 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.273408 25980 mini_oidc.cc:186] Starting OIDC Discovery server
02:03:50.276 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.275893 25980 webserver.cc:533] Webserver started at http://127.0.0.1:45035/ using document root <none> and password file <none>
02:03:50.327 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 2026-08-12T02:03:50Z chronyd version 4.6.1 starting (+CMDMON +NTP +REFCLOCK +RTC -PRIVDROP -SCFILTER -SIGND +ASYNCDNS -NTS -SECHASH -IPV6 +DEBUG)
02:03:50.328 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 2026-08-12T02:03:50Z Disabled control of system clock
02:03:50.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.341609 25980 external_mini_cluster.cc:1372] Running /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:50.343 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:50.343 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/wal
02:03:50.344 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data
02:03:50.344 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --block_manager=log
02:03:50.344 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=localhost
02:03:50.345 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync
02:03:50.345 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:50.346 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:50.346 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:50.347 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/logs
02:03:50.347 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data/info.pb
02:03:50.347 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:50.348 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports
02:03:50.348 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags
02:03:50.348 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags
02:03:50.348 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr
02:03:50.349 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:50.349 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:50.349 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:50.349 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) master
02:03:50.349 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) run
02:03:50.349 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_ca_key_size=768
02:03:50.349 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tsk_num_rsa_bits=512
02:03:50.350 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.62:34279
02:03:50.350 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.62
02:03:50.350 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:50.350 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:50.350 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:50.351 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:50.351 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:03:50.351 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_reuseport=true
02:03:50.351 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --master_addresses=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:50.351 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_jwt_token_auth=true
02:03:50.351 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --jwks_url=http://localhost:38149/jwks.json with env {}
02:03:50.650 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.650113 26000 flags.cc:432] Enabled unsafe flag: --openssl_security_level_override=0
02:03:50.651 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.650722 26000 flags.cc:432] Enabled unsafe flag: --rpc_server_allow_ephemeral_ports=true
02:03:50.651 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.651291 26000 flags.cc:432] Enabled unsafe flag: --never_fsync=true
02:03:50.685 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.684896 26000 flags.cc:432] Enabled experimental flag: --ipki_ca_key_size=768
02:03:50.686 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.685192 26000 flags.cc:432] Enabled experimental flag: --ipki_server_key_size=768
02:03:50.686 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.685391 26000 flags.cc:432] Enabled experimental flag: --tsk_num_rsa_bits=512
02:03:50.686 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.685722 26000 flags.cc:432] Enabled experimental flag: --rpc_reuseport=true
02:03:50.686 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.685978 26000 flags.cc:432] Enabled experimental flag: --enable_jwt_token_auth=true
02:03:50.687 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.686128 26000 flags.cc:432] Enabled experimental flag: --jwks_url=http://localhost:38149/jwks.json
02:03:50.723 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.722541 26000 master_runner.cc:387] Master server non-default flags:
02:03:50.723 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/logs
02:03:50.723 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:50.723 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr=true
02:03:50.724 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:50.724 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:50.725 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:50.725 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:03:50.725 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data
02:03:50.725 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/wal
02:03:50.725 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_ca_key_size=768
02:03:50.725 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --master_addresses=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:50.725 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:50.726 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:50.726 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tsk_num_rsa_bits=512
02:03:50.726 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.62:34279
02:03:50.726 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_reuseport=true
02:03:50.726 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports=true
02:03:50.727 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_jwt_token_auth=true
02:03:50.727 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --jwks_url=http://localhost:38149/jwks.json
02:03:50.727 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:50.727 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:50.727 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data/info.pb
02:03:50.727 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.62
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync=true
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags=true
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags=true
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 
02:03:50.728 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Master server version:
02:03:50.729 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) kudu 1.19.0-SNAPSHOT
02:03:50.729 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) revision 1d9153c248733781bf69132f2d094d9d3c92b2bc
02:03:50.729 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build type FASTDEBUG
02:03:50.729 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) built by None at 12 Aug 2026 01:45:55 UTC on e7f111948823
02:03:50.729 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build id 13299
02:03:50.729 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) TSAN enabled
02:03:50.730 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.724067 26000 env_posix.cc:2285] Not raising this process' open files per process limit of 1048576; it is already as high as it can go
02:03:50.730 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:50.726182 26000 file_cache.cc:504] Constructed file cache file cache with capacity 419430
02:03:50.738 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.738080 26008 instance_detector.cc:116] could not retrieve AWS instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:52.547 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.142601 26006 debug-util.cc:398] Leaking SignalData structure 0x7b080002ee00 after lost signal to thread 26000
02:03:52.547 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.546176 26000 thread.cc:641] OpenStack (cloud detector) Time spent creating pthread: real 1.807s	user 0.614s	sys 1.192s
02:03:52.547 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.546552 26000 thread.cc:608] OpenStack (cloud detector) Time spent starting thread: real 1.808s	user 0.614s	sys 1.192s
02:03:52.547 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:50.740088 26010 instance_detector.cc:116] could not retrieve Azure instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:52.551 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.551286 26011 instance_detector.cc:116] could not retrieve GCE instance metadata: Timed out: curl timeout: Timeout was reached: Resolving timed out after 1806 milliseconds
02:03:52.553 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.552868 26014 instance_detector.cc:116] could not retrieve OpenStack instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:52.553 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.552928 26000 server_base.cc:1056] Not found: could not retrieve instance metadata: unable to detect cloud type of this node, probably running in non-cloud environment
02:03:52.554 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.554210 26000 hybrid_clock.cc:584] initializing the hybrid clock with 'builtin' time source
02:03:52.557 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.556656 26000 hybrid_clock.cc:630] waiting up to --ntp_initial_sync_wait_secs=10 seconds for the clock to synchronize
02:03:52.558 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.557999 26000 hybrid_clock.cc:648] HybridClock initialized: now 1786500232557895 us; error 192 us; skew 500 ppm
02:03:52.559 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.558774 26000 server_base.cc:861] Flag tcmalloc_max_total_thread_cache_bytes is not working since tcmalloc is not enabled.
02:03:52.565 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.564895 26000 webserver.cc:533] Webserver started at http://127.25.95.62:37627/ using document root <none> and password file <none>
02:03:52.566 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.565889 26000 fs_manager.cc:362] Metadata directory not provided
02:03:52.566 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.566094 26000 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
02:03:52.566 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.566491 26000 server_base.cc:909] This appears to be a new deployment of Kudu; creating new FS layout
02:03:52.571 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.571012 26000 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data/instance:
02:03:52.571 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "29fe424418e440cab7bcf500c924a6f9"
02:03:52.572 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:52 on dist-test-slave-znh6"
02:03:52.572 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.572217 26000 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/wal/instance:
02:03:52.573 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "29fe424418e440cab7bcf500c924a6f9"
02:03:52.573 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:52 on dist-test-slave-znh6"
02:03:52.582 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.581830 26000 fs_manager.cc:696] Time spent creating directory manager: real 0.009s	user 0.009s	sys 0.001s
02:03:52.588 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.587885 26025 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
02:03:52.589 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.589221 26000 fs_manager.cc:730] Time spent opening block manager: real 0.004s	user 0.003s	sys 0.002s
02:03:52.590 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.589607 26000 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data,/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/wal
02:03:52.590 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "29fe424418e440cab7bcf500c924a6f9"
02:03:52.590 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:52 on dist-test-slave-znh6"
02:03:52.591 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.590065 26000 fs_report.cc:389] FS layout report
02:03:52.591 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --------------------
02:03:52.591 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) wal directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/wal
02:03:52.592 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) metadata directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/wal
02:03:52.592 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 1 data directories: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data/data
02:03:52.592 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live blocks: 0
02:03:52.592 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes: 0
02:03:52.592 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes (after alignment): 0
02:03:52.593 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total number of LBM containers: 0 (0 full)
02:03:52.593 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for missing blocks
02:03:52.593 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for orphaned blocks
02:03:52.593 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM containers with extra space: 0 (0 repaired)
02:03:52.594 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM container extra space in bytes: 0 (0 repaired)
02:03:52.594 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total incomplete LBM containers: 0 (0 repaired)
02:03:52.594 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total LBM partial records: 0 (0 repaired)
02:03:52.594 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
02:03:52.646 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.645524 26000 rpc_server.cc:225] running with OpenSSL 1.1.1  11 Sep 2018
02:03:52.647 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.647294 26000 env_posix.cc:2285] Not raising this process' running threads per effective uid limit of 18446744073709551615; it is already as high as it can go
02:03:52.648 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.647830 26000 kserver.cc:163] Server-wide thread pool size limit: 3276
02:03:52.721 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.720656 26000 rpc_server.cc:307] RPC server started. Bound to: 127.25.95.62:34279
02:03:52.721 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.720757 26099 acceptor_pool.cc:272] collecting diagnostics on the listening RPC socket 127.25.95.62:34279 every 8 connection(s)
02:03:52.724 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.723718 26000 server_base.cc:1193] Dumped server information to /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/data/info.pb
02:03:52.730 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.730293 26102 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet 00000000000000000000000000000000. 1 dirs total, 0 dirs full, 0 dirs failed
02:03:52.731 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.730774 25980 external_mini_cluster.cc:1434] Started /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu as pid 26000
02:03:52.731 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.731374 25980 external_mini_cluster.cc:1448] Reading /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-0/wal/instance
02:03:52.735 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.734756 25980 external_mini_cluster.cc:1372] Running /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:52.735 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:52.735 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/wal
02:03:52.735 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data
02:03:52.736 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --block_manager=log
02:03:52.736 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=localhost
02:03:52.736 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync
02:03:52.736 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:52.737 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:52.737 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:52.737 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/logs
02:03:52.737 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data/info.pb
02:03:52.737 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:52.738 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports
02:03:52.738 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags
02:03:52.738 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags
02:03:52.738 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr
02:03:52.738 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:52.739 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:52.739 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:52.739 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) master
02:03:52.739 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) run
02:03:52.739 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_ca_key_size=768
02:03:52.739 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tsk_num_rsa_bits=512
02:03:52.740 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.61:36057
02:03:52.740 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.61
02:03:52.740 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:52.741 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:52.741 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:52.741 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:52.741 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:03:52.742 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_reuseport=true
02:03:52.742 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --master_addresses=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:52.742 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_jwt_token_auth=true
02:03:52.742 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --jwks_url=http://localhost:38149/jwks.json with env {}
02:03:52.745 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.741880 26102 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } has no permanent_uuid. Determining permanent_uuid...
02:03:52.773 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.772658 26102 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } has no permanent_uuid. Determining permanent_uuid...
02:03:52.775 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.775195 26026 proxy.cc:239] Call had error, refreshing address and retrying: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:52.780 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.779423 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.61:36057: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:52.829 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.829078 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } attempt: 1
02:03:52.834 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.833618 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.61:36057: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:52.902 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.902037 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } attempt: 2
02:03:52.906 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:52.906373 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.61:36057: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:52.998 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:52.997766 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } attempt: 3
02:03:53.002 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.002108 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.61:36057: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:53.056 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.055960 26104 flags.cc:432] Enabled unsafe flag: --openssl_security_level_override=0
02:03:53.057 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.056536 26104 flags.cc:432] Enabled unsafe flag: --rpc_server_allow_ephemeral_ports=true
02:03:53.057 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.057372 26104 flags.cc:432] Enabled unsafe flag: --never_fsync=true
02:03:53.090 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.090329 26104 flags.cc:432] Enabled experimental flag: --ipki_ca_key_size=768
02:03:53.091 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.090617 26104 flags.cc:432] Enabled experimental flag: --ipki_server_key_size=768
02:03:53.091 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.090829 26104 flags.cc:432] Enabled experimental flag: --tsk_num_rsa_bits=512
02:03:53.091 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.091027 26104 flags.cc:432] Enabled experimental flag: --rpc_reuseport=true
02:03:53.092 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.091207 26104 flags.cc:432] Enabled experimental flag: --enable_jwt_token_auth=true
02:03:53.092 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.091493 26104 flags.cc:432] Enabled experimental flag: --jwks_url=http://localhost:38149/jwks.json
02:03:53.138 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:53.137965 26104 master_runner.cc:387] Master server non-default flags:
02:03:53.139 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/logs
02:03:53.139 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:53.139 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr=true
02:03:53.139 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:53.139 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:53.139 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:53.139 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/wal
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_ca_key_size=768
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --master_addresses=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tsk_num_rsa_bits=512
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.61:36057
02:03:53.140 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_reuseport=true
02:03:53.141 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports=true
02:03:53.141 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_jwt_token_auth=true
02:03:53.141 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --jwks_url=http://localhost:38149/jwks.json
02:03:53.141 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:53.141 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:53.141 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data/info.pb
02:03:53.142 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.61
02:03:53.142 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:53.143 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync=true
02:03:53.143 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:53.143 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags=true
02:03:53.143 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags=true
02:03:53.143 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:53.143 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 
02:03:53.143 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Master server version:
02:03:53.144 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) kudu 1.19.0-SNAPSHOT
02:03:53.144 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) revision 1d9153c248733781bf69132f2d094d9d3c92b2bc
02:03:53.144 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build type FASTDEBUG
02:03:53.144 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) built by None at 12 Aug 2026 01:45:55 UTC on e7f111948823
02:03:53.144 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build id 13299
02:03:53.145 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) TSAN enabled
02:03:53.145 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:53.139395 26104 env_posix.cc:2285] Not raising this process' open files per process limit of 1048576; it is already as high as it can go
02:03:53.145 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:53.141031 26104 file_cache.cc:504] Constructed file cache file cache with capacity 419430
02:03:53.146 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:53.145489 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } attempt: 4
02:03:53.151 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.151417 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.61:36057: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:53.156 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.155453 26123 instance_detector.cc:116] could not retrieve AWS instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:53.452 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:53.450955 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } attempt: 5
02:03:53.458 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.458029 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.61:36057: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:54.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.005584 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } attempt: 6
02:03:54.019 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.019048 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.61:36057: Network error: Client connection negotiation failed: client connection to 127.25.95.61:36057: connect: Connection refused (error 111)
02:03:54.396 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:53.156875 26126 instance_detector.cc:116] could not retrieve Azure instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:54.399 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.398998 26129 instance_detector.cc:116] could not retrieve OpenStack instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:54.404 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.403331 26128 instance_detector.cc:116] could not retrieve GCE instance metadata: Timed out: curl timeout: Timeout was reached: Resolving timed out after 1239 milliseconds
02:03:54.405 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.403534 26104 server_base.cc:1056] Not found: could not retrieve instance metadata: unable to detect cloud type of this node, probably running in non-cloud environment
02:03:54.406 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.406144 26104 hybrid_clock.cc:584] initializing the hybrid clock with 'builtin' time source
02:03:54.411 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.411244 26104 hybrid_clock.cc:630] waiting up to --ntp_initial_sync_wait_secs=10 seconds for the clock to synchronize
02:03:54.413 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.413205 26104 hybrid_clock.cc:648] HybridClock initialized: now 1786500234413160 us; error 41 us; skew 500 ppm
02:03:54.414 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.414345 26104 server_base.cc:861] Flag tcmalloc_max_total_thread_cache_bytes is not working since tcmalloc is not enabled.
02:03:54.421 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.420682 26104 webserver.cc:533] Webserver started at http://127.25.95.61:35793/ using document root <none> and password file <none>
02:03:54.422 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.421679 26104 fs_manager.cc:362] Metadata directory not provided
02:03:54.422 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.421875 26104 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
02:03:54.422 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.422348 26104 server_base.cc:909] This appears to be a new deployment of Kudu; creating new FS layout
02:03:54.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.427261 26104 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data/instance:
02:03:54.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "bd83f3bc7c294d21a06d429455051e3b"
02:03:54.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:54 on dist-test-slave-znh6"
02:03:54.429 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.428699 26104 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/wal/instance:
02:03:54.429 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "bd83f3bc7c294d21a06d429455051e3b"
02:03:54.429 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:54 on dist-test-slave-znh6"
02:03:54.437 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.436645 26104 fs_manager.cc:696] Time spent creating directory manager: real 0.007s	user 0.007s	sys 0.001s
02:03:54.443 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.443162 26141 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
02:03:54.444 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.444270 26104 fs_manager.cc:730] Time spent opening block manager: real 0.004s	user 0.003s	sys 0.001s
02:03:54.445 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.444665 26104 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data,/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/wal
02:03:54.445 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "bd83f3bc7c294d21a06d429455051e3b"
02:03:54.445 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:54 on dist-test-slave-znh6"
02:03:54.445 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.445103 26104 fs_report.cc:389] FS layout report
02:03:54.446 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --------------------
02:03:54.446 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) wal directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/wal
02:03:54.446 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) metadata directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/wal
02:03:54.446 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 1 data directories: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data/data
02:03:54.446 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live blocks: 0
02:03:54.447 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes: 0
02:03:54.447 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes (after alignment): 0
02:03:54.447 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total number of LBM containers: 0 (0 full)
02:03:54.447 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for missing blocks
02:03:54.447 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for orphaned blocks
02:03:54.447 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM containers with extra space: 0 (0 repaired)
02:03:54.448 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM container extra space in bytes: 0 (0 repaired)
02:03:54.448 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total incomplete LBM containers: 0 (0 repaired)
02:03:54.448 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total LBM partial records: 0 (0 repaired)
02:03:54.448 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
02:03:54.506 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.506073 26104 rpc_server.cc:225] running with OpenSSL 1.1.1  11 Sep 2018
02:03:54.508 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.507920 26104 env_posix.cc:2285] Not raising this process' running threads per effective uid limit of 18446744073709551615; it is already as high as it can go
02:03:54.508 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.508514 26104 kserver.cc:163] Server-wide thread pool size limit: 3276
02:03:54.585 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.585026 26104 rpc_server.cc:307] RPC server started. Bound to: 127.25.95.61:36057
02:03:54.586 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.585105 26228 acceptor_pool.cc:272] collecting diagnostics on the listening RPC socket 127.25.95.61:36057 every 8 connection(s)
02:03:54.588 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.587999 26104 server_base.cc:1193] Dumped server information to /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/data/info.pb
02:03:54.594 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.593851 26229 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet 00000000000000000000000000000000. 1 dirs total, 0 dirs full, 0 dirs failed
02:03:54.597 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.597404 25980 external_mini_cluster.cc:1434] Started /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu as pid 26104
02:03:54.598 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.597891 25980 external_mini_cluster.cc:1448] Reading /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-1/wal/instance
02:03:54.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.600932 25980 external_mini_cluster.cc:1372] Running /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:54.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:54.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/wal
02:03:54.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data
02:03:54.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --block_manager=log
02:03:54.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=localhost
02:03:54.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync
02:03:54.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:54.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:54.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:54.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/logs
02:03:54.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data/info.pb
02:03:54.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:54.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports
02:03:54.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags
02:03:54.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags
02:03:54.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr
02:03:54.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:54.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:54.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:54.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) master
02:03:54.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) run
02:03:54.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_ca_key_size=768
02:03:54.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tsk_num_rsa_bits=512
02:03:54.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.60:36419
02:03:54.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.60
02:03:54.605 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:54.605 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:54.605 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:54.605 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:54.605 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:03:54.605 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_reuseport=true
02:03:54.605 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --master_addresses=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:54.606 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_jwt_token_auth=true
02:03:54.606 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --jwks_url=http://localhost:38149/jwks.json with env {}
02:03:54.615 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.611255 26229 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } has no permanent_uuid. Determining permanent_uuid...
02:03:54.637 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.637240 26229 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } has no permanent_uuid. Determining permanent_uuid...
02:03:54.652 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.652362 26229 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } has no permanent_uuid. Determining permanent_uuid...
02:03:54.655 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.654917 26147 proxy.cc:239] Call had error, refreshing address and retrying: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:54.660 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.659572 26229 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:54.709 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.709020 26229 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 1
02:03:54.713 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.713264 26229 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:54.782 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.781781 26229 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 2
02:03:54.786 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.786145 26229 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:54.878 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:54.877681 26229 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 3
02:03:54.882 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.882340 26229 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:54.929 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.929109 26235 flags.cc:432] Enabled unsafe flag: --openssl_security_level_override=0
02:03:54.930 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.929667 26235 flags.cc:432] Enabled unsafe flag: --rpc_server_allow_ephemeral_ports=true
02:03:54.930 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.930310 26235 flags.cc:432] Enabled unsafe flag: --never_fsync=true
02:03:54.964 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.964066 26235 flags.cc:432] Enabled experimental flag: --ipki_ca_key_size=768
02:03:54.964 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.964354 26235 flags.cc:432] Enabled experimental flag: --ipki_server_key_size=768
02:03:54.965 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.964560 26235 flags.cc:432] Enabled experimental flag: --tsk_num_rsa_bits=512
02:03:54.965 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.964756 26235 flags.cc:432] Enabled experimental flag: --rpc_reuseport=true
02:03:54.965 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.964939 26235 flags.cc:432] Enabled experimental flag: --enable_jwt_token_auth=true
02:03:54.965 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:54.965085 26235 flags.cc:432] Enabled experimental flag: --jwks_url=http://localhost:38149/jwks.json
02:03:55.004 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.004024 26235 master_runner.cc:387] Master server non-default flags:
02:03:55.004 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/logs
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr=true
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/wal
02:03:55.005 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_ca_key_size=768
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --master_addresses=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tsk_num_rsa_bits=512
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.60:36419
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_reuseport=true
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports=true
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_jwt_token_auth=true
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --jwks_url=http://localhost:38149/jwks.json
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data/info.pb
02:03:55.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.60
02:03:55.007 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:55.007 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync=true
02:03:55.007 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:55.007 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags=true
02:03:55.007 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags=true
02:03:55.007 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Master server version:
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) kudu 1.19.0-SNAPSHOT
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) revision 1d9153c248733781bf69132f2d094d9d3c92b2bc
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build type FASTDEBUG
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) built by None at 12 Aug 2026 01:45:55 UTC on e7f111948823
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build id 13299
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) TSAN enabled
02:03:55.008 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.005347 26235 env_posix.cc:2285] Not raising this process' open files per process limit of 1048576; it is already as high as it can go
02:03:55.009 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.007596 26235 file_cache.cc:504] Constructed file cache file cache with capacity 419430
02:03:55.021 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.020490 26254 instance_detector.cc:116] could not retrieve AWS instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:55.026 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.025803 26229 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 4
02:03:55.032 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.032143 26229 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.080 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.079605 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } attempt: 7
02:03:55.092 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.091974 26102 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } has no permanent_uuid. Determining permanent_uuid...
02:03:55.098 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.098039 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.157 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.156466 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 1
02:03:55.164 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.163601 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.246 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.245186 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 2
02:03:55.253 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.252481 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.332 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.331702 26229 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 5
02:03:55.340 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.338150 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 3
02:03:55.340 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.339288 26229 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.346 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.345849 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.487 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.486438 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 4
02:03:55.494 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.493479 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.778 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.777069 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 5
02:03:55.784 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.784201 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:55.887 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:55.886852 26229 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 6
02:03:55.898 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.898283 26229 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:56.269 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:55.021682 26255 instance_detector.cc:116] could not retrieve Azure instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:56.271 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:56.271227 26258 instance_detector.cc:116] could not retrieve OpenStack instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:03:56.274 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:56.274304 26257 instance_detector.cc:116] could not retrieve GCE instance metadata: Timed out: curl timeout: Timeout was reached: Resolving timed out after 1247 milliseconds
02:03:56.275 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.274428 26235 server_base.cc:1056] Not found: could not retrieve instance metadata: unable to detect cloud type of this node, probably running in non-cloud environment
02:03:56.275 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.275666 26235 hybrid_clock.cc:584] initializing the hybrid clock with 'builtin' time source
02:03:56.278 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.278198 26235 hybrid_clock.cc:630] waiting up to --ntp_initial_sync_wait_secs=10 seconds for the clock to synchronize
02:03:56.279 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.279592 26235 hybrid_clock.cc:648] HybridClock initialized: now 1786500236279550 us; error 31 us; skew 500 ppm
02:03:56.280 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.280541 26235 server_base.cc:861] Flag tcmalloc_max_total_thread_cache_bytes is not working since tcmalloc is not enabled.
02:03:56.288 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.287878 26235 webserver.cc:533] Webserver started at http://127.25.95.60:40653/ using document root <none> and password file <none>
02:03:56.289 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.288934 26235 fs_manager.cc:362] Metadata directory not provided
02:03:56.289 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.289126 26235 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
02:03:56.289 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.289533 26235 server_base.cc:909] This appears to be a new deployment of Kudu; creating new FS layout
02:03:56.294 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.293871 26235 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data/instance:
02:03:56.294 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "cf61417058bb42a1afeea5f0c6fa0ec3"
02:03:56.294 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:56 on dist-test-slave-znh6"
02:03:56.295 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.295081 26235 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/wal/instance:
02:03:56.295 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "cf61417058bb42a1afeea5f0c6fa0ec3"
02:03:56.295 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:56 on dist-test-slave-znh6"
02:03:56.302 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.302268 26235 fs_manager.cc:696] Time spent creating directory manager: real 0.007s	user 0.006s	sys 0.000s
02:03:56.309 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.308743 26273 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
02:03:56.310 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.309893 26235 fs_manager.cc:730] Time spent opening block manager: real 0.004s	user 0.003s	sys 0.003s
02:03:56.310 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.310256 26235 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data,/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/wal
02:03:56.310 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "cf61417058bb42a1afeea5f0c6fa0ec3"
02:03:56.311 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:03:56 on dist-test-slave-znh6"
02:03:56.311 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.310678 26235 fs_report.cc:389] FS layout report
02:03:56.311 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --------------------
02:03:56.311 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) wal directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/wal
02:03:56.311 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) metadata directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/wal
02:03:56.311 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 1 data directories: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data/data
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live blocks: 0
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes: 0
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes (after alignment): 0
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total number of LBM containers: 0 (0 full)
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for missing blocks
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for orphaned blocks
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM containers with extra space: 0 (0 repaired)
02:03:56.312 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM container extra space in bytes: 0 (0 repaired)
02:03:56.313 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total incomplete LBM containers: 0 (0 repaired)
02:03:56.313 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total LBM partial records: 0 (0 repaired)
02:03:56.313 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
02:03:56.337 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.336822 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 6
02:03:56.344 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:56.344468 26102 consensus_peers.cc:760] Error getting permanent uuid from config peer 127.25.95.60:36419: Network error: Client connection negotiation failed: client connection to 127.25.95.60:36419: connect: Connection refused (error 111)
02:03:56.365 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.365541 26235 rpc_server.cc:225] running with OpenSSL 1.1.1  11 Sep 2018
02:03:56.367 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.367038 26235 env_posix.cc:2285] Not raising this process' running threads per effective uid limit of 18446744073709551615; it is already as high as it can go
02:03:56.367 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.367451 26235 kserver.cc:163] Server-wide thread pool size limit: 3276
02:03:56.447 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.447340 26235 rpc_server.cc:307] RPC server started. Bound to: 127.25.95.60:36419
02:03:56.448 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.447431 26354 acceptor_pool.cc:272] collecting diagnostics on the listening RPC socket 127.25.95.60:36419 every 8 connection(s)
02:03:56.450 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.450238 26235 server_base.cc:1193] Dumped server information to /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/data/info.pb
02:03:56.454 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.453177 25980 external_mini_cluster.cc:1434] Started /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu as pid 26235
02:03:56.454 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.453699 25980 external_mini_cluster.cc:1448] Reading /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/master-2/wal/instance
02:03:56.458 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.458097 26355 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet 00000000000000000000000000000000. 1 dirs total, 0 dirs full, 0 dirs failed
02:03:56.481 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.476981 26355 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } has no permanent_uuid. Determining permanent_uuid...
02:03:56.502 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.502260 26355 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } has no permanent_uuid. Determining permanent_uuid...
02:03:56.515 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.514552 26355 sys_catalog.cc:422] member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } has no permanent_uuid. Determining permanent_uuid...
02:03:56.531 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.531241 26355 tablet_bootstrap.cc:492] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3: Bootstrap starting.
02:03:56.538 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.538439 26355 tablet_bootstrap.cc:654] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3: Neither blocks nor log segments found. Creating new log.
02:03:56.540 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.540417 26355 log.cc:826] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3: Log is configured to *not* fsync() on all Append() calls
02:03:56.545 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.545665 26355 tablet_bootstrap.cc:492] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3: No bootstrap required, opened a new log
02:03:56.565 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.564332 26355 raft_consensus.cc:359] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Replica starting. Triggering 0 pending ops. Active config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:56.565 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.565239 26355 raft_consensus.cc:385] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Consensus starting up: Expiring failure detector timer to make a prompt election more likely
02:03:56.565 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.565551 26355 raft_consensus.cc:740] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Becoming Follower/Learner. State: Replica: cf61417058bb42a1afeea5f0c6fa0ec3, State: Initialized, Role: FOLLOWER
02:03:56.567 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.566460 26355 consensus_queue.cc:260] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [NON_LEADER]: Queue going to NON_LEADER mode. State: All replicated index: 0, Majority replicated index: 0, Committed index: 0, Last appended: 0.0, Last appended by leader: 0, Current term: 0, Majority size: -1, State: 0, Mode: NON_LEADER, active raft config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:56.569 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.568895 26372 sys_catalog.cc:455] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: SysCatalogTable state changed. Reason: RaftConsensus started. Latest consensus state: current_term: 0 committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:56.569 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.569537 26372 sys_catalog.cc:458] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: This master's current role is: FOLLOWER
02:03:56.570 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.570179 26355 sys_catalog.cc:565] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: configured and running, proceeding with master startup.
02:03:56.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:56.603168 26391 catalog_manager.cc:1594] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3: loading cluster ID for follower catalog manager: Not found: cluster ID entry not found
02:03:56.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:56.604089 26391 catalog_manager.cc:883] Not found: cluster ID entry not found: failed to prepare follower catalog manager, will retry
02:03:56.623 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:56.622692 26286 tablet.cc:2406] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3: Can't schedule compaction. Clean time has not been advanced past its initial value.
02:03:56.630 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.596073 26235 master_runner.cc:187] Error getting master registration for 127.25.95.62:34279: OK, instance_id { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" instance_seqno: 1786500232701177 } error { code: CATALOG_MANAGER_NOT_INITIALIZED status { code: SERVICE_UNAVAILABLE message: "Catalog manager is not initialized. State: Starting" } }
02:03:56.630 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.630525 26235 master_runner.cc:419] Couldn't verify the masters in the cluster. Trying again...
02:03:56.835 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.835305 26372 raft_consensus.cc:493] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Starting pre-election (no leader contacted us within the election timeout)
02:03:56.836 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.835872 26372 raft_consensus.cc:515] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Starting pre-election with config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:56.839 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.838611 26372 leader_election.cc:290] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [CANDIDATE]: Term 1 pre-election: Requested pre-vote from peers 29fe424418e440cab7bcf500c924a6f9 (127.25.95.62:34279), bd83f3bc7c294d21a06d429455051e3b (127.25.95.61:36057)
02:03:56.959 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.958799 26229 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 7
02:03:56.985 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.984903 26229 tablet_bootstrap.cc:492] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: Bootstrap starting.
02:03:56.993 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.992892 26229 tablet_bootstrap.cc:654] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: Neither blocks nor log segments found. Creating new log.
02:03:56.996 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:56.995952 26229 log.cc:826] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: Log is configured to *not* fsync() on all Append() calls
02:03:57.004 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.003859 26229 tablet_bootstrap.cc:492] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: No bootstrap required, opened a new log
02:03:57.033 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.033001 26229 raft_consensus.cc:359] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [term 0 FOLLOWER]: Replica starting. Triggering 0 pending ops. Active config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:57.034 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.033814 26229 raft_consensus.cc:385] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [term 0 FOLLOWER]: Consensus starting up: Expiring failure detector timer to make a prompt election more likely
02:03:57.034 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.034106 26229 raft_consensus.cc:740] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [term 0 FOLLOWER]: Becoming Follower/Learner. State: Replica: bd83f3bc7c294d21a06d429455051e3b, State: Initialized, Role: FOLLOWER
02:03:57.035 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.035074 26229 consensus_queue.cc:260] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [NON_LEADER]: Queue going to NON_LEADER mode. State: All replicated index: 0, Majority replicated index: 0, Committed index: 0, Last appended: 0.0, Last appended by leader: 0, Current term: 0, Majority size: -1, State: 0, Mode: NON_LEADER, active raft config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:57.038 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.038029 26397 sys_catalog.cc:455] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [sys.catalog]: SysCatalogTable state changed. Reason: RaftConsensus started. Latest consensus state: current_term: 0 committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.039 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.039183 26397 sys_catalog.cc:458] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [sys.catalog]: This master's current role is: FOLLOWER
02:03:57.040 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.039772 26229 sys_catalog.cc:565] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [sys.catalog]: configured and running, proceeding with master startup.
02:03:57.040 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.040186 26188 tablet_service.cc:1917] Received RequestConsensusVote() RPC: tablet_id: "00000000000000000000000000000000" candidate_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" candidate_term: 1 candidate_status { last_received { term: 0 index: 0 } } ignore_live_leader: false dest_uuid: "bd83f3bc7c294d21a06d429455051e3b" is_pre_election: true
02:03:57.041 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.041184 26188 raft_consensus.cc:2468] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [term 0 FOLLOWER]: Leader pre-election vote request: Granting yes vote for candidate cf61417058bb42a1afeea5f0c6fa0ec3 in term 0.
02:03:57.049 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.042785 26276 leader_election.cc:304] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [CANDIDATE]: Term 1 pre-election: Election decided. Result: candidate won. Election summary: received 2 responses out of 3 voters: 2 yes votes; 0 no votes. yes voters: bd83f3bc7c294d21a06d429455051e3b, cf61417058bb42a1afeea5f0c6fa0ec3; no voters: 
02:03:57.049 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.043877 26372 raft_consensus.cc:2804] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Leader pre-election won for term 1
02:03:57.049 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.044277 26372 raft_consensus.cc:493] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Starting leader election (no leader contacted us within the election timeout)
02:03:57.049 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.044598 26372 raft_consensus.cc:3060] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 0 FOLLOWER]: Advancing to term 1
02:03:57.053 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.052601 26372 raft_consensus.cc:515] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 1 FOLLOWER]: Starting leader election with config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:57.059 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.055996 26188 tablet_service.cc:1917] Received RequestConsensusVote() RPC: tablet_id: "00000000000000000000000000000000" candidate_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" candidate_term: 1 candidate_status { last_received { term: 0 index: 0 } } ignore_live_leader: false dest_uuid: "bd83f3bc7c294d21a06d429455051e3b"
02:03:57.060 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.056561 26188 raft_consensus.cc:3060] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [term 0 FOLLOWER]: Advancing to term 1
02:03:57.060 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.056402 26372 leader_election.cc:290] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [CANDIDATE]: Term 1 election: Requested vote from peers 29fe424418e440cab7bcf500c924a6f9 (127.25.95.62:34279), bd83f3bc7c294d21a06d429455051e3b (127.25.95.61:36057)
02:03:57.072 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.072172 26188 raft_consensus.cc:2468] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [term 1 FOLLOWER]: Leader election vote request: Granting yes vote for candidate cf61417058bb42a1afeea5f0c6fa0ec3 in term 1.
02:03:57.074 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.074085 26276 leader_election.cc:304] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [CANDIDATE]: Term 1 election: Election decided. Result: candidate won. Election summary: received 2 responses out of 3 voters: 2 yes votes; 0 no votes. yes voters: bd83f3bc7c294d21a06d429455051e3b, cf61417058bb42a1afeea5f0c6fa0ec3; no voters: 
02:03:57.077 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.075383 26372 raft_consensus.cc:2804] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 1 FOLLOWER]: Leader election won for term 1
02:03:57.083 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.080672 26372 raft_consensus.cc:697] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [term 1 LEADER]: Becoming Leader. State: Replica: cf61417058bb42a1afeea5f0c6fa0ec3, State: Running, Role: LEADER
02:03:57.083 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.081924 26372 consensus_queue.cc:237] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [LEADER]: Queue going to LEADER mode. State: All replicated index: 0, Majority replicated index: 0, Committed index: 0, Last appended: 0.0, Last appended by leader: 0, Current term: 1, Majority size: 2, State: 0, Mode: LEADER, active raft config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:57.094 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.094267 26407 sys_catalog.cc:455] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: SysCatalogTable state changed. Reason: New leader cf61417058bb42a1afeea5f0c6fa0ec3. Latest consensus state: current_term: 1 leader_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.096 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.094810 26407 sys_catalog.cc:458] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: This master's current role is: LEADER
02:03:57.097 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.097250 26413 catalog_manager.cc:1511] Loading table and tablet metadata into memory...
02:03:57.104 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.104592 26413 catalog_manager.cc:1520] Initializing Kudu cluster ID...
02:03:57.131 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.130412 26188 raft_consensus.cc:1275] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [term 1 FOLLOWER]: Refusing update from remote peer cf61417058bb42a1afeea5f0c6fa0ec3: Log matching property violated. Preceding OpId in replica: term: 0 index: 0. Preceding OpId from leader: term: 1 index: 2. (index mismatch)
02:03:57.132 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:57.130801 26411 catalog_manager.cc:1594] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: loading cluster ID for follower catalog manager: Not found: cluster ID entry not found
02:03:57.132 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:57.131126 26411 catalog_manager.cc:883] Not found: cluster ID entry not found: failed to prepare follower catalog manager, will retry
02:03:57.132 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.090140 26104 master_runner.cc:187] Error getting master registration for 127.25.95.62:34279: OK, instance_id { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" instance_seqno: 1786500232701177 } error { code: CATALOG_MANAGER_NOT_INITIALIZED status { code: SERVICE_UNAVAILABLE message: "Catalog manager is not initialized. State: Starting" } }
02:03:57.133 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.131649 26104 master_runner.cc:419] Couldn't verify the masters in the cluster. Trying again...
02:03:57.142 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.138052 26407 consensus_queue.cc:1048] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [LEADER]: Connected to new peer: Peer: permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 }, Status: LMP_MISMATCH, Last received: 0.0, Next index: 1, Last known committed idx: 0, Time since last communication: 0.000s
02:03:57.169 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.168292 26397 sys_catalog.cc:455] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [sys.catalog]: SysCatalogTable state changed. Reason: New leader cf61417058bb42a1afeea5f0c6fa0ec3. Latest consensus state: current_term: 1 leader_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.169 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.169054 26397 sys_catalog.cc:458] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [sys.catalog]: This master's current role is: FOLLOWER
02:03:57.177 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.176172 26414 mvcc.cc:204] Tried to move back new op lower bound from 7317504971258302464 to 7317504971104411648. Current Snapshot: MvccSnapshot[applied={T|T < 7317504971258302464}]
02:03:57.194 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.193516 26397 sys_catalog.cc:455] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [sys.catalog]: SysCatalogTable state changed. Reason: Replicated consensus-only round. Latest consensus state: current_term: 1 leader_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.195 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.194243 26397 sys_catalog.cc:458] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b [sys.catalog]: This master's current role is: FOLLOWER
02:03:57.203 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.201828 26372 sys_catalog.cc:455] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: SysCatalogTable state changed. Reason: Peer health change. Latest consensus state: current_term: 1 leader_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.203 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.202549 26372 sys_catalog.cc:458] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: This master's current role is: LEADER
02:03:57.214 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.210081 26413 catalog_manager.cc:1383] Generated new cluster ID: 45084c054a594b06b7d075cf5c7bacb7
02:03:57.215 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.210359 26413 catalog_manager.cc:1531] Initializing Kudu internal certificate authority...
02:03:57.264 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.263311 26413 catalog_manager.cc:1406] Generated new certificate authority record
02:03:57.269 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.268981 26413 catalog_manager.cc:1540] Loading token signing keys...
02:03:57.306 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.305646 26413 catalog_manager.cc:6092] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3: Generated new TSK 0
02:03:57.316 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.316217 26413 catalog_manager.cc:1550] Initializing in-progress tserver states...
02:03:57.334 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.334190 25980 external_mini_cluster.cc:1372] Running /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/wal
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --block_manager=log
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=localhost
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/logs
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data/info.pb
02:03:57.335 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) tserver
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) run
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.1:0
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --local_ip_for_outbound_sockets=127.25.95.1
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.1
02:03:57.336 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:57.337 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tserver_master_addrs=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:57.337 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:57.337 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:57.337 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:57.337 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin with env {}
02:03:57.378 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.377933 26102 consensus_peers.cc:770] Retrying to get permanent uuid for remote peer: member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } attempt: 7
02:03:57.415 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.414745 26102 tablet_bootstrap.cc:492] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9: Bootstrap starting.
02:03:57.436 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.435994 26102 tablet_bootstrap.cc:654] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9: Neither blocks nor log segments found. Creating new log.
02:03:57.452 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.451761 26102 log.cc:826] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9: Log is configured to *not* fsync() on all Append() calls
02:03:57.479 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.478520 26102 tablet_bootstrap.cc:492] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9: No bootstrap required, opened a new log
02:03:57.534 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.533569 26102 raft_consensus.cc:359] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [term 0 FOLLOWER]: Replica starting. Triggering 0 pending ops. Active config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:57.535 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.534500 26102 raft_consensus.cc:385] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [term 0 FOLLOWER]: Consensus starting up: Expiring failure detector timer to make a prompt election more likely
02:03:57.535 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.534849 26102 raft_consensus.cc:740] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [term 0 FOLLOWER]: Becoming Follower/Learner. State: Replica: 29fe424418e440cab7bcf500c924a6f9, State: Initialized, Role: FOLLOWER
02:03:57.536 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.535892 26102 consensus_queue.cc:260] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [NON_LEADER]: Queue going to NON_LEADER mode. State: All replicated index: 0, Majority replicated index: 0, Committed index: 0, Last appended: 0.0, Last appended by leader: 0, Current term: 0, Majority size: -1, State: 0, Mode: NON_LEADER, active raft config: opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } }
02:03:57.547 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.546294 26432 sys_catalog.cc:455] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [sys.catalog]: SysCatalogTable state changed. Reason: RaftConsensus started. Latest consensus state: current_term: 0 committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.547 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.547155 26432 sys_catalog.cc:458] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [sys.catalog]: This master's current role is: FOLLOWER
02:03:57.559 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.553593 26102 sys_catalog.cc:565] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [sys.catalog]: configured and running, proceeding with master startup.
02:03:57.559 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.553818 26062 tablet_service.cc:1917] Received RequestConsensusVote() RPC: tablet_id: "00000000000000000000000000000000" candidate_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" candidate_term: 1 candidate_status { last_received { term: 0 index: 0 } } ignore_live_leader: false dest_uuid: "29fe424418e440cab7bcf500c924a6f9"
02:03:57.559 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.554641 26062 raft_consensus.cc:3060] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [term 0 FOLLOWER]: Advancing to term 1
02:03:57.559 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.557618 26064 tablet_service.cc:1917] Received RequestConsensusVote() RPC: tablet_id: "00000000000000000000000000000000" candidate_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" candidate_term: 1 candidate_status { last_received { term: 0 index: 0 } } ignore_live_leader: false dest_uuid: "29fe424418e440cab7bcf500c924a6f9" is_pre_election: true
02:03:57.567 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.566428 26062 raft_consensus.cc:2468] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [term 1 FOLLOWER]: Leader election vote request: Granting yes vote for candidate cf61417058bb42a1afeea5f0c6fa0ec3 in term 1.
02:03:57.570 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.568238 26061 raft_consensus.cc:1275] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [term 1 FOLLOWER]: Refusing update from remote peer cf61417058bb42a1afeea5f0c6fa0ec3: Log matching property violated. Preceding OpId in replica: term: 0 index: 0. Preceding OpId from leader: term: 1 index: 2. (index mismatch)
02:03:57.581 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.578145 26407 consensus_queue.cc:1048] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [LEADER]: Connected to new peer: Peer: permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 }, Status: LMP_MISMATCH, Last received: 0.0, Next index: 1, Last known committed idx: 0, Time since last communication: 0.000s
02:03:57.687 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.685132 26432 sys_catalog.cc:455] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [sys.catalog]: SysCatalogTable state changed. Reason: New leader cf61417058bb42a1afeea5f0c6fa0ec3. Latest consensus state: current_term: 1 leader_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.687 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.685855 26445 sys_catalog.cc:455] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [sys.catalog]: SysCatalogTable state changed. Reason: Replicated consensus-only round. Latest consensus state: current_term: 1 leader_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:57.687 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.686604 26432 sys_catalog.cc:458] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [sys.catalog]: This master's current role is: FOLLOWER
02:03:57.687 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.686767 26445 sys_catalog.cc:458] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9 [sys.catalog]: This master's current role is: FOLLOWER
02:03:57.784 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.783730 26460 catalog_manager.cc:1295] Loaded cluster ID: 45084c054a594b06b7d075cf5c7bacb7
02:03:57.784 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.784029 26460 catalog_manager.cc:1588] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9: loading cluster ID for follower catalog manager: success
02:03:57.799 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.799391 26460 catalog_manager.cc:1610] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9: acquiring CA information for follower catalog manager: success
02:03:57.817 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:57.817045 26460 catalog_manager.cc:1638] T 00000000000000000000000000000000 P 29fe424418e440cab7bcf500c924a6f9: importing token verification keys for follower catalog manager: success; most recent TSK sequence number 0
02:03:57.968 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:57.967367 26426 flags.cc:432] Enabled unsafe flag: --openssl_security_level_override=0
02:03:57.968 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:57.968590 26426 flags.cc:432] Enabled unsafe flag: --rpc_server_allow_ephemeral_ports=true
02:03:57.969 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:57.969691 26426 flags.cc:432] Enabled unsafe flag: --never_fsync=true
02:03:58.039 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:58.038736 26426 flags.cc:432] Enabled experimental flag: --ipki_server_key_size=768
02:03:58.041 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:58.040853 26426 flags.cc:432] Enabled experimental flag: --local_ip_for_outbound_sockets=127.25.95.1
02:03:58.048 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.047201 26407 sys_catalog.cc:455] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: SysCatalogTable state changed. Reason: Peer health change. Latest consensus state: current_term: 1 leader_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" committed_config { opid_index: -1 OBSOLETE_local: false peers { permanent_uuid: "29fe424418e440cab7bcf500c924a6f9" member_type: VOTER last_known_addr { host: "127.25.95.62" port: 34279 } } peers { permanent_uuid: "bd83f3bc7c294d21a06d429455051e3b" member_type: VOTER last_known_addr { host: "127.25.95.61" port: 36057 } } peers { permanent_uuid: "cf61417058bb42a1afeea5f0c6fa0ec3" member_type: VOTER last_known_addr { host: "127.25.95.60" port: 36419 } } }
02:03:58.048 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.048451 26407 sys_catalog.cc:458] T 00000000000000000000000000000000 P cf61417058bb42a1afeea5f0c6fa0ec3 [sys.catalog]: This master's current role is: LEADER
02:03:58.110 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.109932 26426 tablet_server_runner.cc:78] Tablet server non-default flags:
02:03:58.110 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/logs
02:03:58.110 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr=true
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/wal
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.1:0
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports=true
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:03:58.111 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data/info.pb
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.1
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tserver_master_addrs=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync=true
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags=true
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags=true
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --local_ip_for_outbound_sockets=127.25.95.1
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Tablet server version:
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) kudu 1.19.0-SNAPSHOT
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) revision 1d9153c248733781bf69132f2d094d9d3c92b2bc
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build type FASTDEBUG
02:03:58.112 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) built by None at 12 Aug 2026 01:45:55 UTC on e7f111948823
02:03:58.113 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build id 13299
02:03:58.113 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) TSAN enabled
02:03:58.115 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.115036 26426 env_posix.cc:2285] Not raising this process' open files per process limit of 1048576; it is already as high as it can go
02:03:58.117 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.117491 26426 file_cache.cc:504] Constructed file cache file cache with capacity 419430
02:03:58.137 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.136991 26411 catalog_manager.cc:1295] Loaded cluster ID: 45084c054a594b06b7d075cf5c7bacb7
02:03:58.138 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.137881 26411 catalog_manager.cc:1588] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: loading cluster ID for follower catalog manager: success
02:03:58.149 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.149585 26411 catalog_manager.cc:1610] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: acquiring CA information for follower catalog manager: success
02:03:58.156 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:03:58.155623 26411 catalog_manager.cc:1638] T 00000000000000000000000000000000 P bd83f3bc7c294d21a06d429455051e3b: importing token verification keys for follower catalog manager: success; most recent TSK sequence number 0
02:03:58.176 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:58.175714 26472 instance_detector.cc:116] could not retrieve AWS instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:00.439 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:59.562834 26471 debug-util.cc:398] Leaking SignalData structure 0x7b080002ede0 after lost signal to thread 26426
02:04:00.441 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:00.439353 26426 thread.cc:641] OpenStack (cloud detector) Time spent creating pthread: real 2.254s	user 0.419s	sys 0.813s
02:04:00.442 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:00.439787 26426 thread.cc:608] OpenStack (cloud detector) Time spent starting thread: real 2.255s	user 0.419s	sys 0.813s
02:04:00.442 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:00.442178 26475 instance_detector.cc:116] could not retrieve GCE instance metadata: Timed out: curl timeout: Timeout was reached: Resolving timed out after 2255 milliseconds
02:04:00.442 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.442286 26426 server_base.cc:1056] Not found: could not retrieve instance metadata: unable to detect cloud type of this node, probably running in non-cloud environment
02:04:00.443 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:00.442191 26479 instance_detector.cc:116] could not retrieve OpenStack instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:00.443 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:03:58.189136 26473 instance_detector.cc:116] could not retrieve Azure instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:00.448 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.448231 26426 hybrid_clock.cc:584] initializing the hybrid clock with 'builtin' time source
02:04:00.463 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.462946 26426 hybrid_clock.cc:630] waiting up to --ntp_initial_sync_wait_secs=10 seconds for the clock to synchronize
02:04:00.464 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.464455 26426 hybrid_clock.cc:648] HybridClock initialized: now 1786500240464411 us; error 47 us; skew 500 ppm
02:04:00.465 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.465580 26426 server_base.cc:861] Flag tcmalloc_max_total_thread_cache_bytes is not working since tcmalloc is not enabled.
02:04:00.473 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.473450 26426 webserver.cc:533] Webserver started at http://127.25.95.1:42257/ using document root <none> and password file <none>
02:04:00.474 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.474642 26426 fs_manager.cc:362] Metadata directory not provided
02:04:00.475 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.474931 26426 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
02:04:00.475 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.475466 26426 server_base.cc:909] This appears to be a new deployment of Kudu; creating new FS layout
02:04:00.485 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.481671 26426 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data/instance:
02:04:00.485 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "88b88f80550b4535902881af0bd090c7"
02:04:00.485 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:00 on dist-test-slave-znh6"
02:04:00.485 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.483198 26426 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/wal/instance:
02:04:00.485 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "88b88f80550b4535902881af0bd090c7"
02:04:00.485 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:00 on dist-test-slave-znh6"
02:04:00.493 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.493003 26426 fs_manager.cc:696] Time spent creating directory manager: real 0.009s	user 0.000s	sys 0.008s
02:04:00.500 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.500597 26487 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
02:04:00.502 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.502041 26426 fs_manager.cc:730] Time spent opening block manager: real 0.005s	user 0.005s	sys 0.001s
02:04:00.502 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.502445 26426 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data,/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/wal
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "88b88f80550b4535902881af0bd090c7"
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:00 on dist-test-slave-znh6"
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.502899 26426 fs_report.cc:389] FS layout report
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --------------------
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) wal directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/wal
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) metadata directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/wal
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 1 data directories: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data/data
02:04:00.503 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live blocks: 0
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes: 0
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes (after alignment): 0
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total number of LBM containers: 0 (0 full)
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for missing blocks
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for orphaned blocks
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM containers with extra space: 0 (0 repaired)
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM container extra space in bytes: 0 (0 repaired)
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total incomplete LBM containers: 0 (0 repaired)
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total LBM partial records: 0 (0 repaired)
02:04:00.504 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
02:04:00.573 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.572961 26426 rpc_server.cc:225] running with OpenSSL 1.1.1  11 Sep 2018
02:04:00.575 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.575057 26426 env_posix.cc:2285] Not raising this process' running threads per effective uid limit of 18446744073709551615; it is already as high as it can go
02:04:00.575 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.575659 26426 kserver.cc:163] Server-wide thread pool size limit: 3276
02:04:00.580 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.579675 26426 txn_system_client.cc:432] TxnSystemClient initialization is disabled...
02:04:00.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.602496 26426 ts_tablet_manager.cc:585] Loaded tablet metadata (0 total tablets, 0 live tablets)
02:04:00.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.602809 26426 ts_tablet_manager.cc:531] Time spent load tablet metadata: real 0.000s	user 0.000s	sys 0.000s
02:04:00.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.603153 26426 ts_tablet_manager.cc:616] Registered 0 tablets
02:04:00.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.603386 26426 ts_tablet_manager.cc:595] Time spent register tablets: real 0.000s	user 0.000s	sys 0.000s
02:04:00.889 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.889546 26426 rpc_server.cc:307] RPC server started. Bound to: 127.25.95.1:36757
02:04:00.890 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.889671 26672 acceptor_pool.cc:272] collecting diagnostics on the listening RPC socket 127.25.95.1:36757 every 8 connection(s)
02:04:00.894 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.894160 26426 server_base.cc:1193] Dumped server information to /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/data/info.pb
02:04:00.906 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.901150 25980 external_mini_cluster.cc:1434] Started /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu as pid 26426
02:04:00.907 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.901809 25980 external_mini_cluster.cc:1448] Reading /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-0/wal/instance
02:04:00.946 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.942420 25980 external_mini_cluster.cc:1372] Running /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:04:00.946 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:04:00.946 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/wal
02:04:00.946 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data
02:04:00.946 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --block_manager=log
02:04:00.946 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=localhost
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/logs
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data/info.pb
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr
02:04:00.947 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) tserver
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) run
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.2:0
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --local_ip_for_outbound_sockets=127.25.95.2
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.2
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tserver_master_addrs=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:04:00.948 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin with env {}
02:04:00.999 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.998471 26674 heartbeater.cc:344] Connected to a master server at 127.25.95.61:36057
02:04:00.999 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:00.999017 26674 heartbeater.cc:461] Registering TS with master...
02:04:01.000 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.000382 26674 heartbeater.cc:507] Master 127.25.95.61:36057 requested a full tablet report, sending...
02:04:01.002 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.001569 26673 heartbeater.cc:344] Connected to a master server at 127.25.95.60:36419
02:04:01.002 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.001922 26673 heartbeater.cc:461] Registering TS with master...
02:04:01.006 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.005906 26171 ts_manager.cc:194] Registered new tserver with Master: 88b88f80550b4535902881af0bd090c7 (127.25.95.1:36757)
02:04:01.007 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.006668 26673 heartbeater.cc:507] Master 127.25.95.60:36419 requested a full tablet report, sending...
02:04:01.010 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.009510 26302 ts_manager.cc:194] Registered new tserver with Master: 88b88f80550b4535902881af0bd090c7 (127.25.95.1:36757)
02:04:01.012 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.012317 26302 master_service.cc:502] Signed X509 certificate for tserver {username='slave'} at 127.25.95.1:42311
02:04:01.019 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.019455 26675 heartbeater.cc:344] Connected to a master server at 127.25.95.62:34279
02:04:01.020 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.019837 26675 heartbeater.cc:461] Registering TS with master...
02:04:01.020 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.020516 26675 heartbeater.cc:507] Master 127.25.95.62:34279 requested a full tablet report, sending...
02:04:01.025 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.023881 26052 ts_manager.cc:194] Registered new tserver with Master: 88b88f80550b4535902881af0bd090c7 (127.25.95.1:36757)
02:04:01.339 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:01.338328 26685 flags.cc:432] Enabled unsafe flag: --openssl_security_level_override=0
02:04:01.339 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:01.338976 26685 flags.cc:432] Enabled unsafe flag: --rpc_server_allow_ephemeral_ports=true
02:04:01.339 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:01.339629 26685 flags.cc:432] Enabled unsafe flag: --never_fsync=true
02:04:01.385 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:01.385044 26685 flags.cc:432] Enabled experimental flag: --ipki_server_key_size=768
02:04:01.386 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:01.386046 26685 flags.cc:432] Enabled experimental flag: --local_ip_for_outbound_sockets=127.25.95.2
02:04:01.424 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.424449 26685 tablet_server_runner.cc:78] Tablet server non-default flags:
02:04:01.425 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/logs
02:04:01.425 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:04:01.425 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr=true
02:04:01.425 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:04:01.425 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:04:01.425 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:04:01.425 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:04:01.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data
02:04:01.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/wal
02:04:01.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:04:01.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:04:01.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.2:0
02:04:01.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports=true
02:04:01.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data/info.pb
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.2
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tserver_master_addrs=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync=true
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags=true
02:04:01.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags=true
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --local_ip_for_outbound_sockets=127.25.95.2
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Tablet server version:
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) kudu 1.19.0-SNAPSHOT
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) revision 1d9153c248733781bf69132f2d094d9d3c92b2bc
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build type FASTDEBUG
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) built by None at 12 Aug 2026 01:45:55 UTC on e7f111948823
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build id 13299
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) TSAN enabled
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.426234 26685 env_posix.cc:2285] Not raising this process' open files per process limit of 1048576; it is already as high as it can go
02:04:01.428 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:01.428690 26685 file_cache.cc:504] Constructed file cache file cache with capacity 419430
02:04:01.441 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:01.441109 26695 instance_detector.cc:116] could not retrieve AWS instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:02.018 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.017258 26673 heartbeater.cc:499] Master 127.25.95.60:36419 was elected leader, sending a full tablet report...
02:04:02.765 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:01.442786 26696 instance_detector.cc:116] could not retrieve Azure instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:02.769 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:02.768636 26701 instance_detector.cc:116] could not retrieve OpenStack instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:02.773 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:02.773176 26685 thread.cc:641] OpenStack (cloud detector) Time spent creating pthread: real 1.331s	user 0.462s	sys 0.868s
02:04:02.774 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:02.773980 26685 thread.cc:608] OpenStack (cloud detector) Time spent starting thread: real 1.332s	user 0.462s	sys 0.868s
02:04:02.776 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.775789 26685 server_base.cc:1061] running on GCE node
02:04:02.777 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.777171 26685 hybrid_clock.cc:584] initializing the hybrid clock with 'builtin' time source
02:04:02.779 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.779670 26685 hybrid_clock.cc:630] waiting up to --ntp_initial_sync_wait_secs=10 seconds for the clock to synchronize
02:04:02.781 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.781026 26685 hybrid_clock.cc:648] HybridClock initialized: now 1786500242780972 us; error 57 us; skew 500 ppm
02:04:02.782 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.782085 26685 server_base.cc:861] Flag tcmalloc_max_total_thread_cache_bytes is not working since tcmalloc is not enabled.
02:04:02.790 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.789994 26685 webserver.cc:533] Webserver started at http://127.25.95.2:38121/ using document root <none> and password file <none>
02:04:02.791 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.791054 26685 fs_manager.cc:362] Metadata directory not provided
02:04:02.791 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.791311 26685 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
02:04:02.792 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.791981 26685 server_base.cc:909] This appears to be a new deployment of Kudu; creating new FS layout
02:04:02.797 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.796660 26685 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data/instance:
02:04:02.797 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "a9c1476f49964b3f9b148e4a36b0ee6f"
02:04:02.797 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:02 on dist-test-slave-znh6"
02:04:02.798 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.797874 26685 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/wal/instance:
02:04:02.798 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "a9c1476f49964b3f9b148e4a36b0ee6f"
02:04:02.798 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:02 on dist-test-slave-znh6"
02:04:02.806 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.806246 26685 fs_manager.cc:696] Time spent creating directory manager: real 0.008s	user 0.009s	sys 0.001s
02:04:02.813 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.812916 26713 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
02:04:02.814 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.814246 26685 fs_manager.cc:730] Time spent opening block manager: real 0.005s	user 0.005s	sys 0.000s
02:04:02.815 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.814635 26685 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data,/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/wal
02:04:02.815 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "a9c1476f49964b3f9b148e4a36b0ee6f"
02:04:02.815 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:02 on dist-test-slave-znh6"
02:04:02.815 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.815172 26685 fs_report.cc:389] FS layout report
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --------------------
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) wal directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/wal
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) metadata directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/wal
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 1 data directories: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data/data
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live blocks: 0
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes: 0
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes (after alignment): 0
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total number of LBM containers: 0 (0 full)
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for missing blocks
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for orphaned blocks
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM containers with extra space: 0 (0 repaired)
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM container extra space in bytes: 0 (0 repaired)
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total incomplete LBM containers: 0 (0 repaired)
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total LBM partial records: 0 (0 repaired)
02:04:02.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
02:04:02.889 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.889245 26685 rpc_server.cc:225] running with OpenSSL 1.1.1  11 Sep 2018
02:04:02.891 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.890708 26685 env_posix.cc:2285] Not raising this process' running threads per effective uid limit of 18446744073709551615; it is already as high as it can go
02:04:02.891 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.891180 26685 kserver.cc:163] Server-wide thread pool size limit: 3276
02:04:02.894 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.893922 26685 txn_system_client.cc:432] TxnSystemClient initialization is disabled...
02:04:02.898 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.898406 26685 ts_tablet_manager.cc:585] Loaded tablet metadata (0 total tablets, 0 live tablets)
02:04:02.898 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.898641 26685 ts_tablet_manager.cc:531] Time spent load tablet metadata: real 0.000s	user 0.000s	sys 0.000s
02:04:02.899 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.899183 26685 ts_tablet_manager.cc:616] Registered 0 tablets
02:04:02.899 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:02.899343 26685 ts_tablet_manager.cc:595] Time spent register tablets: real 0.000s	user 0.000s	sys 0.000s
02:04:03.061 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.061136 26685 rpc_server.cc:307] RPC server started. Bound to: 127.25.95.2:40661
02:04:03.061 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.061246 26897 acceptor_pool.cc:272] collecting diagnostics on the listening RPC socket 127.25.95.2:40661 every 8 connection(s)
02:04:03.064 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.063978 26685 server_base.cc:1193] Dumped server information to /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/data/info.pb
02:04:03.077 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.072700 25980 external_mini_cluster.cc:1434] Started /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu as pid 26685
02:04:03.077 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.073277 25980 external_mini_cluster.cc:1448] Reading /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-1/wal/instance
02:04:03.098 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.098054 25980 external_mini_cluster.cc:1372] Running /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:04:03.098 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu
02:04:03.098 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/wal
02:04:03.098 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --block_manager=log
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=localhost
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/logs
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data/info.pb
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:04:03.099 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) tserver
02:04:03.100 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) run
02:04:03.100 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.3:0
02:04:03.100 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --local_ip_for_outbound_sockets=127.25.95.3
02:04:03.100 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.3
02:04:03.100 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:04:03.100 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tserver_master_addrs=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:04:03.103 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:04:03.103 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:04:03.103 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:04:03.103 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin with env {}
02:04:03.108 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.108008 26899 heartbeater.cc:344] Connected to a master server at 127.25.95.60:36419
02:04:03.108 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.108552 26899 heartbeater.cc:461] Registering TS with master...
02:04:03.110 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.110033 26899 heartbeater.cc:507] Master 127.25.95.60:36419 requested a full tablet report, sending...
02:04:03.113 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.111589 26900 heartbeater.cc:344] Connected to a master server at 127.25.95.61:36057
02:04:03.113 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.111976 26900 heartbeater.cc:461] Registering TS with master...
02:04:03.113 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.112860 26900 heartbeater.cc:507] Master 127.25.95.61:36057 requested a full tablet report, sending...
02:04:03.113 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.113144 26302 ts_manager.cc:194] Registered new tserver with Master: a9c1476f49964b3f9b148e4a36b0ee6f (127.25.95.2:40661)
02:04:03.115 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.114925 26302 master_service.cc:502] Signed X509 certificate for tserver {username='slave'} at 127.25.95.2:56217
02:04:03.115 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.115326 26902 heartbeater.cc:344] Connected to a master server at 127.25.95.62:34279
02:04:03.117 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.115700 26902 heartbeater.cc:461] Registering TS with master...
02:04:03.117 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.115813 26171 ts_manager.cc:194] Registered new tserver with Master: a9c1476f49964b3f9b148e4a36b0ee6f (127.25.95.2:40661)
02:04:03.117 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.116677 26902 heartbeater.cc:507] Master 127.25.95.62:34279 requested a full tablet report, sending...
02:04:03.119 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.119288 26052 ts_manager.cc:194] Registered new tserver with Master: a9c1476f49964b3f9b148e4a36b0ee6f (127.25.95.2:40661)
02:04:03.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:03.425951 26918 flags.cc:432] Enabled unsafe flag: --openssl_security_level_override=0
02:04:03.426 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:03.426549 26918 flags.cc:432] Enabled unsafe flag: --rpc_server_allow_ephemeral_ports=true
02:04:03.427 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:03.427150 26918 flags.cc:432] Enabled unsafe flag: --never_fsync=true
02:04:03.469 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:03.468698 26918 flags.cc:432] Enabled experimental flag: --ipki_server_key_size=768
02:04:03.469 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:03.469683 26918 flags.cc:432] Enabled experimental flag: --local_ip_for_outbound_sockets=127.25.95.3
02:04:03.508 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.507771 26918 tablet_server_runner.cc:78] Tablet server non-default flags:
02:04:03.508 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --log_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/logs
02:04:03.508 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logbuflevel=-1
02:04:03.508 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --logtostderr=true
02:04:03.508 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_poll_interval_ms=100
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --builtin_ntp_servers=127.25.95.20:33043
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ntp_initial_sync_wait_secs=10
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --time_source=builtin
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_data_dirs=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --fs_wal_dir=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/wal
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --ipki_server_key_size=768
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --openssl_security_level_override=0
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_bind_addresses=127.25.95.3:0
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --rpc_server_allow_ephemeral_ports=true
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --metrics_log_interval_ms=1000
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_format=pb
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --server_dump_info_path=/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data/info.pb
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_interface=127.25.95.3
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --webserver_port=0
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --tserver_master_addrs=127.25.95.62:34279,127.25.95.61:36057,127.25.95.60:36419
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --never_fsync=true
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --redact=none
02:04:03.509 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_experimental_flags=true
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --unlock_unsafe_flags=true
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --enable_minidumps=false
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --local_ip_for_outbound_sockets=127.25.95.3
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Tablet server version:
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) kudu 1.19.0-SNAPSHOT
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) revision 1d9153c248733781bf69132f2d094d9d3c92b2bc
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build type FASTDEBUG
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) built by None at 12 Aug 2026 01:45:55 UTC on e7f111948823
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) build id 13299
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) TSAN enabled
02:04:03.510 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.509191 26918 env_posix.cc:2285] Not raising this process' open files per process limit of 1048576; it is already as high as it can go
02:04:03.511 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:03.511343 26918 file_cache.cc:504] Constructed file cache file cache with capacity 419430
02:04:03.524 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:03.524425 26927 instance_detector.cc:116] could not retrieve AWS instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:04.120 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:04.119058 26899 heartbeater.cc:499] Master 127.25.95.60:36419 was elected leader, sending a full tablet report...
02:04:05.303 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:04.928763 26926 debug-util.cc:398] Leaking SignalData structure 0x7b080002ede0 after lost signal to thread 26918
02:04:05.303 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:05.302781 26918 thread.cc:641] OpenStack (cloud detector) Time spent creating pthread: real 1.778s	user 0.574s	sys 1.200s
02:04:05.303 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:05.303210 26918 thread.cc:608] OpenStack (cloud detector) Time spent starting thread: real 1.779s	user 0.574s	sys 1.200s
02:04:05.303 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:03.525245 26929 instance_detector.cc:116] could not retrieve Azure instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:05.305 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:05.305291 26933 instance_detector.cc:116] could not retrieve OpenStack instance metadata: Network error: curl error: HTTP response code said error: The requested URL returned error: 404
02:04:05.308 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) W20260812 02:04:05.308275 26932 instance_detector.cc:116] could not retrieve GCE instance metadata: Timed out: curl timeout: Timeout was reached: Resolving timed out after 1779 milliseconds
02:04:05.308 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.308300 26918 server_base.cc:1056] Not found: could not retrieve instance metadata: unable to detect cloud type of this node, probably running in non-cloud environment
02:04:05.309 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.309547 26918 hybrid_clock.cc:584] initializing the hybrid clock with 'builtin' time source
02:04:05.311 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.311625 26918 hybrid_clock.cc:630] waiting up to --ntp_initial_sync_wait_secs=10 seconds for the clock to synchronize
02:04:05.313 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.312963 26918 hybrid_clock.cc:648] HybridClock initialized: now 1786500245312931 us; error 60 us; skew 500 ppm
02:04:05.313 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.313720 26918 server_base.cc:861] Flag tcmalloc_max_total_thread_cache_bytes is not working since tcmalloc is not enabled.
02:04:05.320 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.319916 26918 webserver.cc:533] Webserver started at http://127.25.95.3:37369/ using document root <none> and password file <none>
02:04:05.321 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.320811 26918 fs_manager.cc:362] Metadata directory not provided
02:04:05.321 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.320993 26918 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
02:04:05.321 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.321379 26918 server_base.cc:909] This appears to be a new deployment of Kudu; creating new FS layout
02:04:05.326 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.325623 26918 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data/instance:
02:04:05.326 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "9e5649cb79ee43d3a61b00078c8d15b4"
02:04:05.326 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:05 on dist-test-slave-znh6"
02:04:05.327 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.326668 26918 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/wal/instance:
02:04:05.327 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "9e5649cb79ee43d3a61b00078c8d15b4"
02:04:05.327 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:05 on dist-test-slave-znh6"
02:04:05.334 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.333925 26918 fs_manager.cc:696] Time spent creating directory manager: real 0.007s	user 0.006s	sys 0.000s
02:04:05.339 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.339648 26948 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
02:04:05.341 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.340868 26918 fs_manager.cc:730] Time spent opening block manager: real 0.004s	user 0.002s	sys 0.002s
02:04:05.341 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.341184 26918 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data,/tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/wal
02:04:05.341 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) uuid: "9e5649cb79ee43d3a61b00078c8d15b4"
02:04:05.341 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) format_stamp: "Formatted at 2026-08-12 02:04:05 on dist-test-slave-znh6"
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.341559 26918 fs_report.cc:389] FS layout report
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) --------------------
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) wal directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/wal
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) metadata directory: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/wal
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 1 data directories: /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data/data
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live blocks: 0
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes: 0
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total live bytes (after alignment): 0
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total number of LBM containers: 0 (0 full)
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for missing blocks
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Did not check for orphaned blocks
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM containers with extra space: 0 (0 repaired)
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total full LBM container extra space in bytes: 0 (0 repaired)
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total incomplete LBM containers: 0 (0 repaired)
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total LBM partial records: 0 (0 repaired)
02:04:05.342 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
02:04:05.403 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.403218 26918 rpc_server.cc:225] running with OpenSSL 1.1.1  11 Sep 2018
02:04:05.405 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.404860 26918 env_posix.cc:2285] Not raising this process' running threads per effective uid limit of 18446744073709551615; it is already as high as it can go
02:04:05.405 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.405398 26918 kserver.cc:163] Server-wide thread pool size limit: 3276
02:04:05.408 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.408227 26918 txn_system_client.cc:432] TxnSystemClient initialization is disabled...
02:04:05.412 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.412503 26918 ts_tablet_manager.cc:585] Loaded tablet metadata (0 total tablets, 0 live tablets)
02:04:05.413 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.412742 26918 ts_tablet_manager.cc:531] Time spent load tablet metadata: real 0.000s	user 0.000s	sys 0.000s
02:04:05.413 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.413076 26918 ts_tablet_manager.cc:616] Registered 0 tablets
02:04:05.413 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.413290 26918 ts_tablet_manager.cc:595] Time spent register tablets: real 0.000s	user 0.000s	sys 0.000s
02:04:05.566 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.566327 26918 rpc_server.cc:307] RPC server started. Bound to: 127.25.95.3:46139
02:04:05.567 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.566524 27132 acceptor_pool.cc:272] collecting diagnostics on the listening RPC socket 127.25.95.3:46139 every 8 connection(s)
02:04:05.569 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.569149 26918 server_base.cc:1193] Dumped server information to /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/data/info.pb
02:04:05.575 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.571828 25980 external_mini_cluster.cc:1434] Started /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu as pid 26918
02:04:05.575 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.572340 25980 external_mini_cluster.cc:1448] Reading /tmp/dist-test-taskE13Vx3/test-tmp/mini-kudu-cluster858563652130659674/ts-2/wal/instance
02:04:05.618 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.614625 27134 heartbeater.cc:344] Connected to a master server at 127.25.95.61:36057
02:04:05.618 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.615197 27134 heartbeater.cc:461] Registering TS with master...
02:04:05.618 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.616575 27134 heartbeater.cc:507] Master 127.25.95.61:36057 requested a full tablet report, sending...
02:04:05.622 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.621363 26169 ts_manager.cc:194] Registered new tserver with Master: 9e5649cb79ee43d3a61b00078c8d15b4 (127.25.95.3:46139)
02:04:05.624 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.622488 27133 heartbeater.cc:344] Connected to a master server at 127.25.95.60:36419
02:04:05.624 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.622851 27133 heartbeater.cc:461] Registering TS with master...
02:04:05.624 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.623768 27133 heartbeater.cc:507] Master 127.25.95.60:36419 requested a full tablet report, sending...
02:04:05.626 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.625763 27135 heartbeater.cc:344] Connected to a master server at 127.25.95.62:34279
02:04:05.627 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.626122 27135 heartbeater.cc:461] Registering TS with master...
02:04:05.627 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.626348 26302 ts_manager.cc:194] Registered new tserver with Master: 9e5649cb79ee43d3a61b00078c8d15b4 (127.25.95.3:46139)
02:04:05.627 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.626989 27135 heartbeater.cc:507] Master 127.25.95.62:34279 requested a full tablet report, sending...
02:04:05.628 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.628044 26302 master_service.cc:502] Signed X509 certificate for tserver {username='slave'} at 127.25.95.3:53735
02:04:05.630 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.629966 26051 ts_manager.cc:194] Registered new tserver with Master: 9e5649cb79ee43d3a61b00078c8d15b4 (127.25.95.3:46139)
02:04:05.648 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:05.648430 25980 external_mini_cluster.cc:955] 3 TS(s) registered with all masters
02:04:05.660 [DEBUG - main] (MiniKuduCluster.java:195) Response: 
02:04:05.661 [DEBUG - main] (MiniKuduCluster.java:185) Request: get_masters {
}

02:04:05.672 [DEBUG - main] (MiniKuduCluster.java:195) Response: get_masters {
  masters {
    id {
      type: MASTER
      index: 0
    }
    bound_rpc_address {
      host: "127.25.95.62"
      port: 34279
    }
    bound_http_address {
      host: "127.25.95.62"
      port: 37627
    }
  }
  masters {
    id {
      type: MASTER
      index: 1
    }
    bound_rpc_address {
      host: "127.25.95.61"
      port: 36057
    }
    bound_http_address {
      host: "127.25.95.61"
      port: 35793
    }
  }
  masters {
    id {
      type: MASTER
      index: 2
    }
    bound_rpc_address {
      host: "127.25.95.60"
      port: 36419
    }
    bound_http_address {
      host: "127.25.95.60"
      port: 40653
    }
  }
}

02:04:05.676 [DEBUG - main] (MiniKuduCluster.java:185) Request: get_tservers {
}

02:04:05.679 [DEBUG - main] (MiniKuduCluster.java:195) Response: get_tservers {
  tservers {
    id {
      type: TSERVER
      index: 0
    }
    bound_rpc_address {
      host: "127.25.95.1"
      port: 36757
    }
    bound_http_address {
      host: "127.25.95.1"
      port: 42257
    }
  }
  tservers {
    id {
      type: TSERVER
      index: 1
    }
    bound_rpc_address {
      host: "127.25.95.2"
      port: 40661
    }
    bound_http_address {
      host: "127.25.95.2"
      port: 38121
    }
  }
  tservers {
    id {
      type: TSERVER
      index: 2
    }
    bound_rpc_address {
      host: "127.25.95.3"
      port: 46139
    }
    bound_http_address {
      host: "127.25.95.3"
      port: 37369
    }
  }
}

02:04:05.679 [INFO - main] (KuduTestHarness.java:157) Creating a new Kudu client...
02:04:05.844 [DEBUG - main] (CompositeStrategy.java:59) Unable to load modern Subject methods, relying only on legacy methods
java.lang.NoSuchMethodException: javax.security.auth.Subject.current()
	at java.base/java.lang.Class.getDeclaredMethod(Class.java:2677)
	at org.apache.kudu.client.internals.ModernStrategy.<init>(ModernStrategy.java:51)
	at org.apache.kudu.client.internals.CompositeStrategy.<init>(CompositeStrategy.java:52)
	at org.apache.kudu.client.internals.CompositeStrategy.<clinit>(CompositeStrategy.java:41)
	at org.apache.kudu.client.internals.SecurityManagerCompatibility.get(SecurityManagerCompatibility.java:43)
	at org.apache.kudu.client.SecurityContext.setupSubject(SecurityContext.java:155)
	at org.apache.kudu.client.SecurityContext.<init>(SecurityContext.java:138)
	at org.apache.kudu.client.AsyncKuduClient.<init>(AsyncKuduClient.java:431)
	at org.apache.kudu.client.AsyncKuduClient$AsyncKuduClientBuilder.build(AsyncKuduClient.java:3109)
	at org.apache.kudu.test.KuduTestHarness.before(KuduTestHarness.java:161)
	at org.junit.rules.ExternalResource$1.evaluate(ExternalResource.java:50)
	at org.apache.kudu.test.junit.RetryRule$RetryStatement.doOneAttemptAndReport(RetryRule.java:184)
	at org.apache.kudu.test.junit.RetryRule$RetryStatement.evaluate(RetryRule.java:244)
	at org.junit.runners.ParentRunner$3.evaluate(ParentRunner.java:306)
	at org.junit.runners.BlockJUnit4ClassRunner$1.evaluate(BlockJUnit4ClassRunner.java:100)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:366)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:103)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:63)
	at org.junit.runners.ParentRunner$4.run(ParentRunner.java:331)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:79)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:329)
	at org.junit.runners.ParentRunner.access$100(ParentRunner.java:66)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:293)
	at org.junit.runners.ParentRunner$3.evaluate(ParentRunner.java:306)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:413)
	at org.junit.runners.Suite.runChild(Suite.java:128)
	at org.junit.runners.Suite.runChild(Suite.java:27)
	at org.junit.runners.ParentRunner$4.run(ParentRunner.java:331)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:79)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:329)
	at org.junit.runners.ParentRunner.access$100(ParentRunner.java:66)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:293)
	at org.junit.runners.ParentRunner$3.evaluate(ParentRunner.java:306)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:413)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:137)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:115)
	at org.junit.runner.JUnitCore.runMain(JUnitCore.java:77)
	at org.junit.runner.JUnitCore.main(JUnitCore.java:36)
02:04:05.900 [DEBUG - main] (SecurityUtil.java:122) Could not login via JAAS. Using no credentials: Unable to obtain Principal Name for authentication 
02:04:06.081 [DEBUG - main] (Connection.java:748) [peer master-127.25.95.60:36419(127.25.95.60:36419)] connecting to peer
02:04:06.142 [DEBUG - main] (Connection.java:748) [peer master-127.25.95.61:36057(127.25.95.61:36057)] connecting to peer
02:04:06.144 [DEBUG - main] (Connection.java:748) [peer master-127.25.95.62:34279(127.25.95.62:34279)] connecting to peer
02:04:06.169 [DEBUG - kudu-nio-1] (Connection.java:757) [peer master-127.25.95.61:36057(127.25.95.61:36057)] Successfully connected to peer
02:04:06.171 [DEBUG - kudu-nio-0] (Connection.java:757) [peer master-127.25.95.60:36419(127.25.95.60:36419)] Successfully connected to peer
02:04:06.174 [DEBUG - kudu-nio-2] (Connection.java:757) [peer master-127.25.95.62:34279(127.25.95.62:34279)] Successfully connected to peer
02:04:06.273 [DEBUG - kudu-nio-0] (Negotiator.java:528) SASL mechanism PLAIN chosen for peer 127.25.95.60
02:04:06.273 [DEBUG - kudu-nio-1] (Negotiator.java:528) SASL mechanism PLAIN chosen for peer 127.25.95.61
02:04:06.274 [DEBUG - kudu-nio-2] (Negotiator.java:528) SASL mechanism PLAIN chosen for peer 127.25.95.62
02:04:06.512 [DEBUG - kudu-nio-1] (Negotiator.java:918) Authenticated connection [id: 0xb758906c, L:/127.0.0.1:56424 - R:/127.25.95.61:36057] using SASL/PLAIN
02:04:06.512 [DEBUG - kudu-nio-2] (Negotiator.java:918) Authenticated connection [id: 0xc8c8ea55, L:/127.0.0.1:42786 - R:/127.25.95.62:34279] using SASL/PLAIN
02:04:06.512 [DEBUG - kudu-nio-0] (Negotiator.java:918) Authenticated connection [id: 0x26dd08fd, L:/127.0.0.1:49310 - R:/127.25.95.60:36419] using SASL/PLAIN
02:04:06.546 [DEBUG - kudu-nio-0] (AsyncKuduClient.java:2538) Learned about tablet Kudu Master for table 'Kudu Master' with partition [<start>, <end>)
02:04:06.547 [DEBUG - kudu-nio-0] (AsyncKuduClient.java:1488) Retrying sending RPC KuduRpc(method=CreateTable, tablet=null, attempt=1, TimeoutTracker(timeout=50000, elapsed=519), Traces: [0ms] refreshing cache from master, [35ms] Sub RPC ConnectToMaster: sending RPC to server master-127.25.95.60:36419, [109ms] Sub RPC ConnectToMaster: sending RPC to server master-127.25.95.61:36057, [111ms] Sub RPC ConnectToMaster: sending RPC to server master-127.25.95.62:34279, [492ms] Sub RPC ConnectToMaster: received response from server master-127.25.95.62:34279: OK, [492ms] Sub RPC ConnectToMaster: received response from server master-127.25.95.61:36057: OK, [492ms] Sub RPC ConnectToMaster: received response from server master-127.25.95.60:36419: OK, deferred=null) after lookup
02:04:06.600 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.598369 26302 catalog_manager.cc:2283] Servicing CreateTable request from {username='slave'} at 127.0.0.1:49310:
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) name: "org.apache.kudu.client.TestStatistics-1786500229105"
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) schema {
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   columns {
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     name: "key"
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     type: INT32
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_key: true
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_nullable: false
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     cfile_block_size: 0
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     immutable: false
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_auto_incrementing: false
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   }
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   columns {
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     name: "column1_i"
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     type: INT32
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_key: false
02:04:06.601 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_nullable: false
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     cfile_block_size: 0
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     immutable: false
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_auto_incrementing: false
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   }
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   columns {
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     name: "column2_i"
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     type: INT32
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_key: false
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_nullable: false
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     cfile_block_size: 0
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     immutable: false
02:04:06.602 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_auto_incrementing: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   }
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   columns {
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     name: "column3_s"
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     type: STRING
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_key: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_nullable: true
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     encoding: DICT_ENCODING
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     compression: LZ4
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     cfile_block_size: 4096
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     immutable: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_auto_incrementing: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   }
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   columns {
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     name: "column4_b"
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     type: BOOL
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_key: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_nullable: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     cfile_block_size: 0
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     immutable: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     is_auto_incrementing: false
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   }
02:04:06.603 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) }
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) num_replicas: 1
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) partition_schema {
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   range_schema {
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     columns {
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)       name: "key"
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)     }
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751)   }
02:04:06.604 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) }
02:04:06.632 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.631861 27133 heartbeater.cc:499] Master 127.25.95.60:36419 was elected leader, sending a full tablet report...
02:04:06.698 [DEBUG - kudu-nio-0] (AsyncKuduClient.java:894) Opened table f8966550a02d4ef198b1cb130625714a
02:04:06.711 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.709940 26575 tablet_service.cc:1511] Processing CreateTablet for tablet 315729c71d5f46988a67f7395c5ee8ca (DEFAULT_TABLE table=org.apache.kudu.client.TestStatistics-1786500229105 [id=f8966550a02d4ef198b1cb130625714a]), partition=RANGE (key) PARTITION UNBOUNDED
02:04:06.712 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.711934 26575 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet 315729c71d5f46988a67f7395c5ee8ca. 1 dirs total, 0 dirs full, 0 dirs failed
02:04:06.739 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.738960 27184 tablet_bootstrap.cc:492] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7: Bootstrap starting.
02:04:06.746 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.746572 27184 tablet_bootstrap.cc:654] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7: Neither blocks nor log segments found. Creating new log.
02:04:06.751 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.749763 27184 log.cc:826] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7: Log is configured to *not* fsync() on all Append() calls
02:04:06.769 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.768719 27184 tablet_bootstrap.cc:492] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7: No bootstrap required, opened a new log
02:04:06.771 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.769289 27184 ts_tablet_manager.cc:1403] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7: Time spent bootstrapping tablet: real 0.031s	user 0.004s	sys 0.019s
02:04:06.798 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.798065 27184 raft_consensus.cc:359] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 0 FOLLOWER]: Replica starting. Triggering 0 pending ops. Active config: opid_index: -1 OBSOLETE_local: true peers { permanent_uuid: "88b88f80550b4535902881af0bd090c7" member_type: VOTER last_known_addr { host: "127.25.95.1" port: 36757 } }
02:04:06.799 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.798871 27184 raft_consensus.cc:385] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 0 FOLLOWER]: Consensus starting up: Expiring failure detector timer to make a prompt election more likely
02:04:06.799 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.799203 27184 raft_consensus.cc:740] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 0 FOLLOWER]: Becoming Follower/Learner. State: Replica: 88b88f80550b4535902881af0bd090c7, State: Initialized, Role: FOLLOWER
02:04:06.800 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.800261 27184 consensus_queue.cc:260] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [NON_LEADER]: Queue going to NON_LEADER mode. State: All replicated index: 0, Majority replicated index: 0, Committed index: 0, Last appended: 0.0, Last appended by leader: 0, Current term: 0, Majority size: -1, State: 0, Mode: NON_LEADER, active raft config: opid_index: -1 OBSOLETE_local: true peers { permanent_uuid: "88b88f80550b4535902881af0bd090c7" member_type: VOTER last_known_addr { host: "127.25.95.1" port: 36757 } }
02:04:06.801 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.800992 27184 raft_consensus.cc:399] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 0 FOLLOWER]: Only one voter in the Raft config. Triggering election immediately
02:04:06.801 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.801354 27184 raft_consensus.cc:493] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 0 FOLLOWER]: Starting leader election (initial election of a single-replica configuration)
02:04:06.802 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.801769 27184 raft_consensus.cc:3060] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 0 FOLLOWER]: Advancing to term 1
02:04:06.808 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.808046 27184 raft_consensus.cc:515] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 1 FOLLOWER]: Starting leader election with config: opid_index: -1 OBSOLETE_local: true peers { permanent_uuid: "88b88f80550b4535902881af0bd090c7" member_type: VOTER last_known_addr { host: "127.25.95.1" port: 36757 } }
02:04:06.809 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.808938 27184 leader_election.cc:304] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [CANDIDATE]: Term 1 election: Election decided. Result: candidate won. Election summary: received 1 responses out of 1 voters: 1 yes votes; 0 no votes. yes voters: 88b88f80550b4535902881af0bd090c7; no voters: 
02:04:06.812 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.811712 27184 leader_election.cc:290] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [CANDIDATE]: Term 1 election: Requested vote from peers 
02:04:06.813 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.812157 27186 raft_consensus.cc:2804] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 1 FOLLOWER]: Leader election won for term 1
02:04:06.815 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.814783 27186 raft_consensus.cc:697] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [term 1 LEADER]: Becoming Leader. State: Replica: 88b88f80550b4535902881af0bd090c7, State: Running, Role: LEADER
02:04:06.816 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.815682 27186 consensus_queue.cc:237] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 [LEADER]: Queue going to LEADER mode. State: All replicated index: 0, Majority replicated index: 0, Committed index: 0, Last appended: 0.0, Last appended by leader: 0, Current term: 1, Majority size: 1, State: 0, Mode: LEADER, active raft config: opid_index: -1 OBSOLETE_local: true peers { permanent_uuid: "88b88f80550b4535902881af0bd090c7" member_type: VOTER last_known_addr { host: "127.25.95.1" port: 36757 } }
02:04:06.821 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.820580 27184 ts_tablet_manager.cc:1434] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7: Time spent starting tablet: real 0.051s	user 0.040s	sys 0.010s
02:04:06.833 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:06.832614 26302 catalog_manager.cc:5719] T 315729c71d5f46988a67f7395c5ee8ca P 88b88f80550b4535902881af0bd090c7 reported cstate change: term changed from 0 to 1, leader changed from <none> to 88b88f80550b4535902881af0bd090c7 (127.25.95.1). New cstate: current_term: 1 leader_uuid: "88b88f80550b4535902881af0bd090c7" committed_config { opid_index: -1 OBSOLETE_local: true peers { permanent_uuid: "88b88f80550b4535902881af0bd090c7" member_type: VOTER last_known_addr { host: "127.25.95.1" port: 36757 } health_report { overall_health: HEALTHY } } }
02:04:06.895 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@403834764(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:06.896 [DEBUG - kudu-nio-0] (AsyncKuduClient.java:2538) Learned about tablet 315729c71d5f46988a67f7395c5ee8ca for table 'org.apache.kudu.client.TestStatistics-1786500229105' with partition [<start>, <end>)
02:04:06.902 [DEBUG - kudu-nio-0] (TableLocationsCache.java:192) Discovered table locations:	[Tablet{lowerBoundPartitionKey=0x, upperBoundPartitionKey=0x, ttl=299994, tablet=315729c71d5f46988a67f7395c5ee8ca@[88b88f80550b4535902881af0bd090c7(127.25.95.1:36757)[L]]}]
02:04:06.905 [DEBUG - kudu-nio-0] (AsyncKuduClient.java:2538) Learned about tablet 315729c71d5f46988a67f7395c5ee8ca for table 'org.apache.kudu.client.TestStatistics-1786500229105' with partition [<start>, <end>)
02:04:06.905 [DEBUG - kudu-nio-0] (TableLocationsCache.java:192) Discovered table locations:	[Tablet{lowerBoundPartitionKey=0x, upperBoundPartitionKey=0x, ttl=299999, tablet=315729c71d5f46988a67f7395c5ee8ca@[88b88f80550b4535902881af0bd090c7(127.25.95.1:36757)[L]]}]
02:04:06.916 [DEBUG - kudu-nio-0] (Connection.java:748) [peer 88b88f80550b4535902881af0bd090c7(127.25.95.1:36757)] connecting to peer
02:04:06.920 [DEBUG - kudu-nio-3] (Connection.java:757) [peer 88b88f80550b4535902881af0bd090c7(127.25.95.1:36757)] Successfully connected to peer
02:04:07.002 [DEBUG - kudu-nio-3] (Negotiator.java:918) Authenticated connection [id: 0x4a6e36b6, L:/127.0.0.1:52190 - R:/127.25.95.1:36757] using TOKEN/null
02:04:07.043 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@1226673809(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.056 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@1102827097(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.068 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@3617520(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.078 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@139045838(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.088 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@763741520(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.098 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@844308415(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.108 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@197794743(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.117 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@1318635227(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.127 [DEBUG - Time-limited test] (AsyncKuduSession.java:592) flushing buffer: Buffer{operations=2, operationSize=108, flusherTask=null, flushNotification=Deferred@1303655709(state=PENDING, result=null, callback=<none>, errback=<none>)}
02:04:07.336 [DEBUG - main] (Connection.java:575) [peer master-127.25.95.60:36419(127.25.95.60:36419)] disconnecting while in state READY
02:04:07.337 [DEBUG - main] (Connection.java:575) [peer master-127.25.95.62:34279(127.25.95.62:34279)] disconnecting while in state READY
02:04:07.337 [DEBUG - main] (Connection.java:575) [peer master-127.25.95.61:36057(127.25.95.61:36057)] disconnecting while in state READY
02:04:07.337 [DEBUG - main] (Connection.java:575) [peer 88b88f80550b4535902881af0bd090c7(127.25.95.1:36757)] disconnecting while in state READY
02:04:07.341 [DEBUG - kudu-nio-0] (AsyncKuduClient.java:2704) Releasing all remaining resources
02:04:07.342 [DEBUG - kudu-nio-1] (Connection.java:239) [peer master-127.25.95.61:36057(127.25.95.61:36057)] handling channelInactive
02:04:07.342 [DEBUG - kudu-nio-2] (Connection.java:239) [peer master-127.25.95.62:34279(127.25.95.62:34279)] handling channelInactive
02:04:07.342 [DEBUG - kudu-nio-3] (Connection.java:239) [peer 88b88f80550b4535902881af0bd090c7(127.25.95.1:36757)] handling channelInactive
02:04:07.343 [DEBUG - kudu-nio-1] (Connection.java:709) [peer master-127.25.95.61:36057(127.25.95.61:36057)] cleaning up while in state READY due to: connection closed
02:04:07.343 [DEBUG - kudu-nio-3] (Connection.java:709) [peer 88b88f80550b4535902881af0bd090c7(127.25.95.1:36757)] cleaning up while in state READY due to: connection closed
02:04:07.343 [DEBUG - kudu-nio-2] (Connection.java:709) [peer master-127.25.95.62:34279(127.25.95.62:34279)] cleaning up while in state READY due to: connection closed
02:04:07.345 [DEBUG - kudu-nio-0] (Connection.java:239) [peer master-127.25.95.60:36419(127.25.95.60:36419)] handling channelInactive
02:04:07.345 [DEBUG - kudu-nio-0] (Connection.java:709) [peer master-127.25.95.60:36419(127.25.95.60:36419)] cleaning up while in state READY due to: connection closed
02:04:07.346 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:07.345837 25980 external_mini_cluster.cc:1664] Killing /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu with pid 26426
02:04:07.413 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:07.412590 25980 external_mini_cluster.cc:1664] Killing /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu with pid 26685
02:04:07.465 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:07.444710 25980 external_mini_cluster.cc:1664] Killing /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu with pid 26918
02:04:07.490 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:07.489677 25980 external_mini_cluster.cc:1664] Killing /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu with pid 26000
02:04:07.523 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:07.523010 25980 external_mini_cluster.cc:1664] Killing /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu with pid 26104
02:04:07.562 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) I20260812 02:04:07.562018 25980 external_mini_cluster.cc:1664] Killing /tmp/dist-test-taskE13Vx3/build/tsan/bin/kudu with pid 26235
02:04:08.759 [INFO - cluster stderr printer] (MiniKuduCluster.java:751) 2026-08-12T02:04:08Z chronyd exiting

Time: 20.764

OK (1 test)

