[==========] Running 5 tests from 1 test suite.
[----------] Global test environment set-up.
[----------] 5 tests from TestHighMemCompaction
[ RUN      ] TestHighMemCompaction.TestRowSetCompactionProceedWithNoBudgetingConstraints
WARNING: Logging before InitGoogleLogging() is written to STDERR
I20260812 07:22:02.175853  3586 fs_manager.cc:362] Metadata directory not provided
I20260812 07:22:02.175985  3586 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
I20260812 07:22:02.177579  3586 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionProceedWithNoBudgetingConstraints.1786519322168857-3586-0/fs_root/instance:
uuid: "afd51aafd832471da443edd180b2c2fe"
format_stamp: "Formatted at 2026-08-12 07:22:02 on dist-test-slave-7lbf"
I20260812 07:22:02.181054  3586 fs_manager.cc:696] Time spent creating directory manager: real 0.003s	user 0.002s	sys 0.001s
I20260812 07:22:02.182921  3594 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
I20260812 07:22:02.183445  3586 fs_report.cc:389] FS layout report
--------------------
wal directory: 
metadata directory: 
1 data directories: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionProceedWithNoBudgetingConstraints.1786519322168857-3586-0/fs_root/data
Total live blocks: 0
Total live bytes: 0
Total live bytes (after alignment): 0
Total number of LBM containers: 0 (0 full)
Did not check for missing blocks
Did not check for orphaned blocks
Total full LBM containers with extra space: 0 (0 repaired)
Total full LBM container extra space in bytes: 0 (0 repaired)
Total incomplete LBM containers: 0 (0 repaired)
Total LBM partial records: 0 (0 repaired)
Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
I20260812 07:22:02.183759  3586 fs_manager.cc:730] Time spent opening block manager: real 0.002s	user 0.000s	sys 0.001s
I20260812 07:22:02.183804  3586 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionProceedWithNoBudgetingConstraints.1786519322168857-3586-0/fs_root
uuid: "afd51aafd832471da443edd180b2c2fe"
format_stamp: "Formatted at 2026-08-12 07:22:02 on dist-test-slave-7lbf"
I20260812 07:22:02.184271  3586 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet test_tablet_id. 1 dirs total
I20260812 07:22:57.075385  3586 compaction-highmem-test.cc:225] CompactRowSetsOp complete. Timing: real 0.826s	user 0.817s	sys 0.012s Metrics: {"bytes_written":4946,"cfile_cache_hit":110,"cfile_cache_hit_bytes":4700,"cfile_cache_miss":370,"cfile_cache_miss_bytes":3795210,"cfile_init":51,"delta_iterators_relevant":40,"dirs.queue_time_us":1404,"dirs.run_cpu_time_us":817,"dirs.run_wall_time_us":1472,"drs_written":1,"lbm_read_time_us":3077,"lbm_reads_lt_1ms":574,"lbm_write_time_us":3654,"lbm_writes_lt_1ms":137,"mutex_wait_us":334,"num_input_rowsets":10,"peak_mem_usage":20850964,"rows_written":20,"spinlock_wait_cycles":28928,"thread_start_us":381,"threads_started":5}
[       OK ] TestHighMemCompaction.TestRowSetCompactionProceedWithNoBudgetingConstraints (54912 ms)
[ RUN      ] TestHighMemCompaction.TestRowSetCompactionSkipWithBudgetingConstraints
I20260812 07:22:57.090533  3586 fs_manager.cc:362] Metadata directory not provided
I20260812 07:22:57.090591  3586 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
I20260812 07:22:57.090934  3586 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionSkipWithBudgetingConstraints.1786519322168857-3586-0/fs_root/instance:
uuid: "a0eead14595c4d90a750dddf5ee53ad5"
format_stamp: "Formatted at 2026-08-12 07:22:57 on dist-test-slave-7lbf"
I20260812 07:22:57.092432  3586 fs_manager.cc:696] Time spent creating directory manager: real 0.001s	user 0.003s	sys 0.000s
I20260812 07:22:57.093235  3607 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
I20260812 07:22:57.093438  3586 fs_report.cc:389] FS layout report
--------------------
wal directory: 
metadata directory: 
1 data directories: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionSkipWithBudgetingConstraints.1786519322168857-3586-0/fs_root/data
Total live blocks: 0
Total live bytes: 0
Total live bytes (after alignment): 0
Total number of LBM containers: 0 (0 full)
Did not check for missing blocks
Did not check for orphaned blocks
Total full LBM containers with extra space: 0 (0 repaired)
Total full LBM container extra space in bytes: 0 (0 repaired)
Total incomplete LBM containers: 0 (0 repaired)
Total LBM partial records: 0 (0 repaired)
Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
I20260812 07:22:57.093569  3586 fs_manager.cc:730] Time spent opening block manager: real 0.001s	user 0.001s	sys 0.000s
I20260812 07:22:57.093612  3586 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionSkipWithBudgetingConstraints.1786519322168857-3586-0/fs_root
uuid: "a0eead14595c4d90a750dddf5ee53ad5"
format_stamp: "Formatted at 2026-08-12 07:22:57 on dist-test-slave-7lbf"
I20260812 07:22:57.093819  3586 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet test_tablet_id. 1 dirs total
I20260812 07:23:51.799973  3586 rowset_info.cc:301] RowSet(1) removed from compaction input due to memory constraints
I20260812 07:23:51.802386  3586 tablet.cc:2106] T test_tablet_id P a0eead14595c4d90a750dddf5ee53ad5: Compaction resulted in no output rows (all input rows were GCed!)  Removing all input rowsets.
I20260812 07:23:51.803831  3586 compaction-highmem-test.cc:225] CompactRowSetsOp complete. Timing: real 0.004s	user 0.005s	sys 0.000s Metrics: {"dirs.queue_time_us":717,"dirs.run_cpu_time_us":699,"dirs.run_wall_time_us":3939,"lbm_write_time_us":107,"lbm_writes_lt_1ms":7,"mutex_wait_us":39,"num_input_rowsets":0,"spinlock_wait_cycles":4992,"thread_start_us":344,"threads_started":5}
[       OK ] TestHighMemCompaction.TestRowSetCompactionSkipWithBudgetingConstraints (54718 ms)
[ RUN      ] TestHighMemCompaction.TestMajorCompactionMemoryPressure
I20260812 07:23:51.812381  3586 fs_manager.cc:362] Metadata directory not provided
I20260812 07:23:51.812434  3586 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
I20260812 07:23:51.812726  3586 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestMajorCompactionMemoryPressure.1786519322168857-3586-0/fs_root/instance:
uuid: "58cdd16eb610456980f7190a0e4b7a91"
format_stamp: "Formatted at 2026-08-12 07:23:51 on dist-test-slave-7lbf"
I20260812 07:23:51.814116  3586 fs_manager.cc:696] Time spent creating directory manager: real 0.001s	user 0.000s	sys 0.004s
I20260812 07:23:51.814867  3621 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
I20260812 07:23:51.815124  3586 fs_report.cc:389] FS layout report
--------------------
wal directory: 
metadata directory: 
1 data directories: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestMajorCompactionMemoryPressure.1786519322168857-3586-0/fs_root/data
Total live blocks: 0
Total live bytes: 0
Total live bytes (after alignment): 0
Total number of LBM containers: 0 (0 full)
Did not check for missing blocks
Did not check for orphaned blocks
Total full LBM containers with extra space: 0 (0 repaired)
Total full LBM container extra space in bytes: 0 (0 repaired)
Total incomplete LBM containers: 0 (0 repaired)
Total LBM partial records: 0 (0 repaired)
Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
I20260812 07:23:51.815248  3586 fs_manager.cc:730] Time spent opening block manager: real 0.001s	user 0.001s	sys 0.000s
I20260812 07:23:51.815287  3586 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestMajorCompactionMemoryPressure.1786519322168857-3586-0/fs_root
uuid: "58cdd16eb610456980f7190a0e4b7a91"
format_stamp: "Formatted at 2026-08-12 07:23:51 on dist-test-slave-7lbf"
I20260812 07:23:51.815466  3586 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet test_tablet_id. 1 dirs total
W20260812 07:24:46.371932  3586 delta_compaction.cc:129] beyond hard memory limit of 1073741824 with current consumption at 71917056; MajorDeltaCompaction ops consumption: tablet-test_tablet_id 32768, total 32768
[       OK ] TestHighMemCompaction.TestMajorCompactionMemoryPressure (54642 ms)
[ RUN      ] TestHighMemCompaction.TestRowSetCompactionMemoryPressure
I20260812 07:24:46.458668  3586 fs_manager.cc:362] Metadata directory not provided
I20260812 07:24:46.458729  3586 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
I20260812 07:24:46.459029  3586 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionMemoryPressure.1786519322168857-3586-0/fs_root/instance:
uuid: "8643f5a5f73f4cc2ba6aa5d819dd3c1c"
format_stamp: "Formatted at 2026-08-12 07:24:46 on dist-test-slave-7lbf"
I20260812 07:24:46.460378  3586 fs_manager.cc:696] Time spent creating directory manager: real 0.001s	user 0.003s	sys 0.000s
I20260812 07:24:46.461190  3629 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
I20260812 07:24:46.461392  3586 fs_report.cc:389] FS layout report
--------------------
wal directory: 
metadata directory: 
1 data directories: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionMemoryPressure.1786519322168857-3586-0/fs_root/data
Total live blocks: 0
Total live bytes: 0
Total live bytes (after alignment): 0
Total number of LBM containers: 0 (0 full)
Did not check for missing blocks
Did not check for orphaned blocks
Total full LBM containers with extra space: 0 (0 repaired)
Total full LBM container extra space in bytes: 0 (0 repaired)
Total incomplete LBM containers: 0 (0 repaired)
Total LBM partial records: 0 (0 repaired)
Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
I20260812 07:24:46.461491  3586 fs_manager.cc:730] Time spent opening block manager: real 0.001s	user 0.001s	sys 0.000s
I20260812 07:24:46.461555  3586 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.TestRowSetCompactionMemoryPressure.1786519322168857-3586-0/fs_root
uuid: "8643f5a5f73f4cc2ba6aa5d819dd3c1c"
format_stamp: "Formatted at 2026-08-12 07:24:46 on dist-test-slave-7lbf"
I20260812 07:24:46.461751  3586 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet test_tablet_id. 1 dirs total
W20260812 07:25:41.308918  3586 compaction.cc:319] beyond hard memory limit of 1073741824 with current consumption at 94347016; Rowset merge compaction ops consumption: tablet 32768, total 32768
W20260812 07:25:41.460943  3586 compaction.cc:729] beyond hard memory limit of 1073741824 with current consumption at 119776792; Rowset merge compaction ops consumption: tablet 20850964, total 20850964
[       OK ] TestHighMemCompaction.TestRowSetCompactionMemoryPressure (55691 ms)
[ RUN      ] TestHighMemCompaction.HighDeltaVolumeWithFrequentFlushForRowsetCompaction
I20260812 07:25:42.154112  3586 fs_manager.cc:362] Metadata directory not provided
I20260812 07:25:42.154175  3586 fs_manager.cc:368] Using write-ahead log directory (fs_wal_dir) as metadata directory
I20260812 07:25:42.154511  3586 fs_manager.cc:1068] Generated new instance metadata in path /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.HighDeltaVolumeWithFrequentFlushForRowsetCompaction.1786519322168857-3586-0/fs_root/instance:
uuid: "24fd6c24ab864febbdff7f08219d7b01"
format_stamp: "Formatted at 2026-08-12 07:25:42 on dist-test-slave-7lbf"
I20260812 07:25:42.155980  3586 fs_manager.cc:696] Time spent creating directory manager: real 0.001s	user 0.002s	sys 0.000s
I20260812 07:25:42.156848  3637 log_block_manager.cc:4127] Time spent loading block containers with low live blocks: real 0.000s	user 0.000s	sys 0.000s
I20260812 07:25:42.157100  3586 fs_report.cc:389] FS layout report
--------------------
wal directory: 
metadata directory: 
1 data directories: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.HighDeltaVolumeWithFrequentFlushForRowsetCompaction.1786519322168857-3586-0/fs_root/data
Total live blocks: 0
Total live bytes: 0
Total live bytes (after alignment): 0
Total number of LBM containers: 0 (0 full)
Did not check for missing blocks
Did not check for orphaned blocks
Total full LBM containers with extra space: 0 (0 repaired)
Total full LBM container extra space in bytes: 0 (0 repaired)
Total incomplete LBM containers: 0 (0 repaired)
Total LBM partial records: 0 (0 repaired)
Total corrupted LBM metadata records in RocksDB: 0 (0 repaired)
I20260812 07:25:42.157207  3586 fs_manager.cc:730] Time spent opening block manager: real 0.001s	user 0.001s	sys 0.000s
I20260812 07:25:42.157248  3586 fs_manager.cc:647] Opened local filesystem: /tmp/dist-test-tasksZ7Iee/test-tmp/compaction-highmem-test.0.TestHighMemCompaction.HighDeltaVolumeWithFrequentFlushForRowsetCompaction.1786519322168857-3586-0/fs_root
uuid: "24fd6c24ab864febbdff7f08219d7b01"
format_stamp: "Formatted at 2026-08-12 07:25:42 on dist-test-slave-7lbf"
I20260812 07:25:42.157461  3586 data_dirs.cc:400] Could only allocate 1 dirs of requested 3 for tablet test_tablet_id. 1 dirs total
I20260812 07:25:43.650624  3586 compaction-highmem-test.cc:395] Major delta compaction ran: base_data=663316 bytes, redo_deltas=0 bytes, undo_deltas=1021539 bytes, total=1684855 bytes, size_factor=1, rows_per_rowset=20)
W20260812 07:25:43.652616  3586 compaction.cc:319] beyond hard memory limit of 1073741824 with current consumption at 127240144; Rowset merge compaction ops consumption: tablet 32768, total 32768 [suppressed 119 similar messages]
W20260812 07:25:43.900393  3586 compaction.cc:729] beyond hard memory limit of 1073741824 with current consumption at 368549256; Rowset merge compaction ops consumption: tablet 252784830, total 252784830 [suppressed 29 similar messages]
I20260812 07:25:44.230927  3586 compaction-highmem-test.cc:571] CompactRowSetsOp complete. Timing: real 0.580s	user 0.364s	sys 0.216s Metrics: {"bytes_written":72502,"cfile_cache_hit":110,"cfile_cache_hit_bytes":682599,"cfile_cache_miss":3770,"cfile_cache_miss_bytes":2677119,"cfile_init":51,"delta_iterators_relevant":40,"dirs.queue_time_us":1445,"dirs.run_cpu_time_us":198,"dirs.run_wall_time_us":1452,"drs_written":1,"lbm_read_time_us":11855,"lbm_reads_lt_1ms":3974,"lbm_write_time_us":11335,"lbm_writes_lt_1ms":1828,"mutex_wait_us":31,"num_input_rowsets":10,"peak_mem_usage":252784830,"rows_written":200,"spinlock_wait_cycles":768,"thread_start_us":445,"threads_started":7}
[       OK ] TestHighMemCompaction.HighDeltaVolumeWithFrequentFlushForRowsetCompaction (2083 ms)
[----------] 5 tests from TestHighMemCompaction (222063 ms total)

[----------] Global test environment tear-down
[==========] 5 tests from 1 test suite ran. (222064 ms total)
[  PASSED  ] 5 tests.
I20260812 07:25:44.315127  3586 logging.cc:436] LogThrottler /workspace/apache/dev/local/kudu/src/kudu/tablet/compaction.cc:729: suppressed but not reported on 209 messages since previous log ~0 seconds ago
I20260812 07:25:44.315227  3586 logging.cc:436] LogThrottler /workspace/apache/dev/local/kudu/src/kudu/tablet/compaction.cc:319: suppressed but not reported on 119 messages since previous log ~0 seconds ago
I20260812 07:25:44.315244  3586 logging.cc:436] LogThrottler /workspace/apache/dev/local/kudu/src/kudu/tablet/delta_compaction.cc:129: suppressed but not reported on 7 messages since previous log ~57 seconds ago
I20260812 07:25:44.315260  3586 logging.cc:436] LogThrottler /workspace/apache/dev/local/kudu/src/kudu/tablet/rowset_info.cc:301: suppressed but not reported on 9 messages since previous log ~112 seconds ago
