2024/11/23-19:18:23.145601 139957273912896 DEBG dcompact_worker.cpp:2214: /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00: fork to child time = 0.007165 sec 2024/11/23-19:18:23.146295 139957273912896 DEBG dcompact_worker.cpp:1013: Beg SerDeRead: /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00 2024/11/23-19:18:23.151154 139957273912896 DEBG dcompact_worker.cpp:1033: End SerDeRead: /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00 2024/11/23-19:18:23.152035 139957273912896 TRAC dcompact_worker.cpp:1083: INFO_LOG_LEVEL: rpc = INFO_LEVEL, env_var = undefined 2024/11/23-19:18:23.152242 139957273912896 [WARN] [column_family.cc:386] multiple cf_paths/db_paths and level_compaction_dynamic_level_bytes can't be used together 2024/11/23-19:18:23.205669 139957273912896 [version_set.cc:6208] Recovering from manifest file: /worker/dcompact-log/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/2024-11-22T14.14.14/.rocksdb/job-34030/att-00/MANIFEST-206347 2024/11/23-19:18:23.238654 139957273912896 [version_set.cc:6251] Recovered from manifest file:/worker/dcompact-log/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/2024-11-22T14.14.14/.rocksdb/job-34030/att-00/MANIFEST-206347 succeeded,manifest_file_number is 206347, next_file_number is 276863, last_sequence is 4210866496, log_number is 0,prev_log_number is 0,max_column_family is 0,min_log_number_to_keep is 276660 2024/11/23-19:18:23.238659 139957273912896 [version_set.cc:6266] Column family [default] (ID 0), log number is 0 2024/11/23-19:18:23.238741 139957273912896 [version_set.cc:5721] Creating manifest 276863 2024/11/23-19:18:23.270869 139957273912896 DEBG dcompact_worker.cpp:1218: /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00: bottommost_level: fake = 1, rpc = 0 2024/11/23-19:18:23.290373 139957273912896 [compaction_job.cc:2437] [default] [JOB 34030] Compacting 1@2 + 6@3 files to L3, score 1.00, subcompactions 1 : 1 2024/11/23-19:18:23.290383 139957273912896 [compaction_job.cc:2445] [default]: Compaction start summary: Base version 25478 Base level 2, inputs: [276791(27MB)], [276861(16MB) 276711(35MB) 276712(37MB) 276713(34MB) 276714(34MB) 276815(34MB)] 2024/11/23-19:18:23.296916 139957273912896 [top_zip_table.cc:59] core git_version_hash_info_is:commit fc4ab4f2fbfdcdfa23a955d69e26d2fc533b902d Author: leipeng Date: 2024-04-16 20:29:43 +0800 test_sso.cpp: test swap g++ (GCC) 12.1.0 Copyright (C) 2022 Free Software Foundation, Inc. This is free software; see the source for copying conditions. There is NO warranty; not even for MERCHANTABILITY or FITNESS FOR A PARTICULAR PURPOSE. INCS = -Isrc -I3rdparty/re2 -I3rdparty/zstd -Iboost-include CXXFLAGS = -D TOPLING_IO_WITH_URING=1 -fPIC -time -Wno-class-memaccess -fdiagnostics-color -Wformat=2 -Wcomment -Wall -Wextra -Wno-unused-parameter -Wno-alloc-size-larger-than -mcx16 -Wno-deprecated-declarations -Wstrict-aliasing=3 -DCLIENT_LICENSE_ID="public" -DNO_THREADS -ftls-model=initial-exec -DDIVSUFSORT_API= -fno-stack-protector RLS_FLAGS = -O3 -DNDEBUG -g3 WITH_BMI2 = 1 compile_cpu_flag: -march=haswell -mbmi -mbmi2 2024/11/23-19:18:23.296947 139957273912896 [top_zip_table.cc:60] fsa git_version_hash_info_is:commit fc4ab4f2fbfdcdfa23a955d69e26d2fc533b902d Author: leipeng Date: 2024-04-16 20:29:43 +0800 test_sso.cpp: test swap g++ (GCC) 12.1.0 Copyright (C) 2022 Free Software Foundation, Inc. This is free software; see the source for copying conditions. There is NO warranty; not even for MERCHANTABILITY or FITNESS FOR A PARTICULAR PURPOSE. INCS = -Isrc -I3rdparty/re2 -I3rdparty/zstd -Iboost-include CXXFLAGS = -D TOPLING_IO_WITH_URING=1 -fPIC -time -Wno-class-memaccess -fdiagnostics-color -Wformat=2 -Wcomment -Wall -Wextra -Wno-unused-parameter -Wno-alloc-size-larger-than -mcx16 -Wno-deprecated-declarations -Wstrict-aliasing=3 -DCLIENT_LICENSE_ID="public" -DNO_THREADS -ftls-model=initial-exec -DDIVSUFSORT_API= -fno-stack-protector RLS_FLAGS = -O3 -DNDEBUG -g3 WITH_BMI2 = 1 compile_cpu_flag: -march=haswell -mbmi -mbmi2 2024/11/23-19:18:23.296965 139957273912896 [top_zip_table.cc:61] zbs git_version_hash_info_is:commit fc4ab4f2fbfdcdfa23a955d69e26d2fc533b902d Author: leipeng Date: 2024-04-16 20:29:43 +0800 test_sso.cpp: test swap g++ (GCC) 12.1.0 Copyright (C) 2022 Free Software Foundation, Inc. This is free software; see the source for copying conditions. There is NO warranty; not even for MERCHANTABILITY or FITNESS FOR A PARTICULAR PURPOSE. INCS = -Isrc -I3rdparty/re2 -I3rdparty/zstd -Iboost-include CXXFLAGS = -D TOPLING_IO_WITH_URING=1 -fPIC -time -Wno-class-memaccess -fdiagnostics-color -Wformat=2 -Wcomment -Wall -Wextra -Wno-unused-parameter -Wno-alloc-size-larger-than -mcx16 -Wno-deprecated-declarations -Wstrict-aliasing=3 -DCLIENT_LICENSE_ID="public" -DNO_THREADS -ftls-model=initial-exec -DDIVSUFSORT_API= -fno-stack-protector RLS_FLAGS = -O3 -DNDEBUG -g3 WITH_BMI2 = 1 compile_cpu_flag: -march=haswell -mbmi -mbmi2 2024/11/23-19:18:23.296970 139957273912896 [top_zip_table.cc:62] topling-zip_table_reader: git_version_hash_info_is: commit a4a382006cb82713acf5b3425835f22711877681 Author: leipeng Date: 2024-04-11 19:44:14 +0800 fixed_len_hole_index.cc: Add env bool FixedLenHoleIndexUseAVX512 for ut & debug 1. FixedLenHoleIndexUseAVX512 is only in unit tests or debug 2. In release mode, use avx512 by compile options(-march=) g++ (GCC) 12.1.0 Copyright (C) 2022 Free Software Foundation, Inc. This is free software; see the source for copying conditions. There is NO warranty; not even for MERCHANTABILITY or FITNESS FOR A PARTICULAR PURPOSE. cpu_flag: -march=native -mbmi -mbmi2 2024/11/23-19:18:23.296993 139957273912896 [top_zip_table.cc:64] topling-rocks git_version_hash_info_is: commit feab587e468621ba0204d47b4ffacc52e7c4290d Author: leipeng Date: 2024-03-22 13:35:06 +0800 ToplingZipTableBuilder::Add: immediately return after error This function returns void, and caller does not check builder->status() after calling this function and graceful abandon. So immediately return after error, and return error status in Finish(). g++ (GCC) 12.1.0 Copyright (C) 2022 Free Software Foundation, Inc. This is free software; see the source for copying conditions. There is NO warranty; not even for MERCHANTABILITY or FITNESS FOR A PARTICULAR PURPOSE. cpu_flag: -march=native -mbmi -mbmi2 2024/11/23-19:18:23.831672 139957273912896 [top_zip_table_builder.cc:934] ToplingZipTableBuilder(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276864.sst) /dev/shm/ToplingTemp/Topling-163467-kWcVyM 2024/11/23-19:18:24.783195 139957273912896 [top_zip_table_builder.cc:1352] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276864.sst): first pass time = 0.95's, 141.062'MB/sec 2024/11/23-19:18:26.126752 139957273912896 [top_zip_table_builder.cc:2772] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276864.sst): old prealloc_size = 147639500, real_size = 34280864 2024/11/23-19:18:26.127364 139957273912896 [top_zip_table_builder.cc:1773] BuildReorderMap(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276864.sst): index type = NestLoudsTrieDAWG_Mixed_XL_256_32_FL, store type = DictZipBlobStore usrkeys = 926561 prefix = 4 raw-key = 0.0148 GB zip-key = 0.0018 GB avg-key = 16.00 avg-zkey = 1.90 raw-val = 0.1083 GB zip-val = 0.0323 GB avg-val = 116.86 avg-zval = 34.85 2024/11/23-19:18:26.128161 139957273912896 [top_zip_table_builder.cc:1299] /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276864.sst: sumWaitingMem = 0.002 GB, sumWorkingMem = 0.000 GB, reorder workingMem = 0.0023 GB, waited 0.000 sec, Key+Value = 0.134 GB 2024/11/23-19:18:26.965589 139957273912896 [top_zip_table_builder.cc:3100] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276864.sst): second pass time = 1.34's, 80.643'MB/sec, value only(80.7% of KV) wait indexing time = 0.00's, remap KeyValue time = 0.84's, 45.614'MB/sec (all stages of remap) Get OrderMap time = 0.00's, 2975.114'MB/sec (index lex order gen) rebuild zvType time = 0.71's, 0.324'MB/sec write SST data time = 0.12's, 308.800'MB/sec dict compress time = 4356233619.02's, 0.000'MB/sec z-dict build time = 0.00's, sample length = 1.080'MB, throughput = 31993.840'MB/sec zip my value time = 1.34's, unzip length = 0.108'GB zip my value throughput = 80.643'MB/sec zip pipeline throughput = 80.643'MB/sec entries = 926561 avg-key = 28.00 avg-zkey = 1.90 avg-val = 116.86 avg-zval = 34.85 usrkeys = 926561 avg-key = 20.00 avg-zkey = 1.90 avg-val = 123.86 avg-zval = 34.85 TagRS{ kinds = RS_Key0_Tag1 bytes = 0 } TagArray{ size = 926561 bytes = 3127152 } seq expand size = 6485927 multi value expand size = 0 cnt WriteAppend = 12 UnZipSize{ index = 0.0185 GB value = 0.1083 GB dict = 1.08 MB all = 0.1342 GB } __ZipSize{ index = 0.0018 GB value = 0.0323 GB dict = 1.08 MB all = 0.0383 GB } UnZip/Zip{ index = 10.5111 value = 3.3536 dict = 1.00 all = 3.5078 } Zip/UnZip{ index = 0.0951 value = 0.2982 dict = 1.00 all = 0.2851 } ---------------------------- total value len = 8.963380 GB avg = 0.168 KB (by entry num) total key len = 1.466765 GB avg = 0.028 KB total ukey len = 1.016409 GB avg = 0.015 KB total ukey num = 0.066476996 Billion total entry num = 0.053284725 Billion write speed all = 0.278920016 MB/sec (with seq num) write speed all = 0.267520614 MB/sec (without seq num) 2024/11/23-19:18:27.012253 139957273912896 [compaction_job.cc:1948] [default] [JOB 34030] Generated table #276864: 926561 keys, 38262400 bytes, temperature: kWarm 2024/11/23-19:18:27.012355 139957273912896 EVENT_LOG_v1 {"time_micros": 1732360707012291, "cf_name": "default", "job": 34030, "event": "table_file_creation", "file_number": 276864, "file_size": 38262400, "file_checksum": "", "file_checksum_func_name": "Unknown", "smallest_seqno": 4116739076, "largest_seqno": 4210213817, "table_properties": {"data_size": 32286032, "index_size": 1763008, "index_partitions": 0, "top_level_index_size": 0, "index_key_is_user_key": 0, "index_value_is_delta_encoded": 0, "filter_size": 0, "raw_key_size": 25943708, "raw_average_key_size": 28, "raw_value_size": 108274030, "raw_average_value_size": 116, "num_data_blocks": 1, "num_entries": 926561, "num_filter_entries": 0, "num_deletions": 0, "num_merge_operands": 0, "num_range_deletions": 0, "format_version": 0, "fixed_key_len": 28, "fixed_value_len": 18446744073709551615, "filter_policy": "", "column_family_name": "default", "column_family_id": 0, "comparator": "leveldb.BytewiseComparator", "merge_operator": "nullptr", "prefix_extractor_name": "nullptr", "property_collectors": "[Rdb_tbl_prop_coll_factory]", "compression": "FlatZip", "compression_options": "RS_Key0_Tag1-NestLoudsTrieDAWG_Mixed_XL_256_32_FL-DictZipBlobStore", "creation_time": 1732360703, "oldest_key_time": 0, "file_creation_time": 1732360703, "slow_compression_estimated_data_size": 0, "fast_compression_estimated_data_size": 0, "db_id": "d89b4006-2803-486e-b7a2-759bcf348921", "db_session_id": "U1ECJGOXSO4Y1P7ZZXV1", "orig_file_number": 276864, "seqno_to_time_mapping": "N/A", "__indexstats__": "[...1 records...]"}} 2024/11/23-19:18:27.048914 139957273912896 [top_zip_table_builder.cc:934] ToplingZipTableBuilder(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276865.sst) /dev/shm/ToplingTemp/Topling-163467-FKkotM 2024/11/23-19:18:27.898320 139957273912896 [top_zip_table_builder.cc:1352] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276865.sst): first pass time = 0.85's, 158.020'MB/sec 2024/11/23-19:18:29.257106 139957273912896 [top_zip_table_builder.cc:2772] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276865.sst): old prealloc_size = 147639500, real_size = 34102288 2024/11/23-19:18:29.257660 139957273912896 [top_zip_table_builder.cc:1773] BuildReorderMap(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276865.sst): index type = NestLoudsTrieDAWG_Mixed_XL_256_32_FL, store type = DictZipBlobStore usrkeys = 926511 prefix = 4 raw-key = 0.0148 GB zip-key = 0.0018 GB avg-key = 16.00 avg-zkey = 1.91 raw-val = 0.1083 GB zip-val = 0.0321 GB avg-val = 116.86 avg-zval = 34.64 2024/11/23-19:18:29.258410 139957273912896 [top_zip_table_builder.cc:1299] /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276865.sst: sumWaitingMem = 0.002 GB, sumWorkingMem = 0.000 GB, reorder workingMem = 0.0023 GB, waited 0.000 sec, Key+Value = 0.134 GB 2024/11/23-19:18:30.105678 139957273912896 [top_zip_table_builder.cc:3100] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276865.sst): second pass time = 1.36's, 79.741'MB/sec, value only(80.7% of KV) wait indexing time = 0.00's, remap KeyValue time = 0.85's, 44.882'MB/sec (all stages of remap) Get OrderMap time = 0.00's, 3346.634'MB/sec (index lex order gen) rebuild zvType time = 0.72's, 0.321'MB/sec write SST data time = 0.13's, 302.023'MB/sec dict compress time = 4356233619.02's, 0.000'MB/sec z-dict build time = 0.00's, sample length = 1.081'MB, throughput = 32236.294'MB/sec zip my value time = 1.36's, unzip length = 0.108'GB zip my value throughput = 79.741'MB/sec zip pipeline throughput = 79.741'MB/sec entries = 926511 avg-key = 28.00 avg-zkey = 1.91 avg-val = 116.86 avg-zval = 34.64 usrkeys = 926511 avg-key = 20.00 avg-zkey = 1.91 avg-val = 123.86 avg-zval = 34.64 TagRS{ kinds = RS_Key0_Tag1 bytes = 0 } TagArray{ size = 926511 bytes = 3126992 } seq expand size = 6485577 multi value expand size = 0 cnt WriteAppend = 14 UnZipSize{ index = 0.0185 GB value = 0.1083 GB dict = 1.08 MB all = 0.1342 GB } __ZipSize{ index = 0.0018 GB value = 0.0321 GB dict = 1.08 MB all = 0.0381 GB } UnZip/Zip{ index = 10.4442 value = 3.3735 dict = 1.00 all = 3.5242 } Zip/UnZip{ index = 0.0957 value = 0.2964 dict = 1.00 all = 0.2837 } ---------------------------- total value len = 9.078141 GB avg = 0.167 KB (by entry num) total key len = 1.492707 GB avg = 0.028 KB total ukey len = 1.034939 GB avg = 0.015 KB total ukey num = 0.067403507 Billion total entry num = 0.054211236 Billion write speed all = 0.282658931 MB/sec (with seq num) write speed all = 0.271062291 MB/sec (without seq num) 2024/11/23-19:18:30.152333 139957273912896 [compaction_job.cc:1948] [default] [JOB 34030] Generated table #276865: 926511 keys, 38084290 bytes, temperature: kWarm 2024/11/23-19:18:30.152404 139957273912896 EVENT_LOG_v1 {"time_micros": 1732360710152367, "cf_name": "default", "job": 34030, "event": "table_file_creation", "file_number": 276865, "file_size": 38084290, "file_checksum": "", "file_checksum_func_name": "Unknown", "smallest_seqno": 4096159344, "largest_seqno": 4210214339, "table_properties": {"data_size": 32096256, "index_size": 1774208, "index_partitions": 0, "top_level_index_size": 0, "index_key_is_user_key": 0, "index_value_is_delta_encoded": 0, "filter_size": 0, "raw_key_size": 25942308, "raw_average_key_size": 28, "raw_value_size": 108275474, "raw_average_value_size": 116, "num_data_blocks": 1, "num_entries": 926511, "num_filter_entries": 0, "num_deletions": 0, "num_merge_operands": 0, "num_range_deletions": 0, "format_version": 0, "fixed_key_len": 28, "fixed_value_len": 18446744073709551615, "filter_policy": "", "column_family_name": "default", "column_family_id": 0, "comparator": "leveldb.BytewiseComparator", "merge_operator": "nullptr", "prefix_extractor_name": "nullptr", "property_collectors": "[Rdb_tbl_prop_coll_factory]", "compression": "FlatZip", "compression_options": "RS_Key0_Tag1-NestLoudsTrieDAWG_Mixed_XL_256_32_FL-DictZipBlobStore", "creation_time": 1732360707, "oldest_key_time": 0, "file_creation_time": 1732360707, "slow_compression_estimated_data_size": 0, "fast_compression_estimated_data_size": 0, "db_id": "d89b4006-2803-486e-b7a2-759bcf348921", "db_session_id": "U1ECJGOXSO4Y1P7ZZXV1", "orig_file_number": 276865, "seqno_to_time_mapping": "N/A", "__indexstats__": "[...1 records...]"}} 2024/11/23-19:18:30.188632 139957273912896 [top_zip_table_builder.cc:934] ToplingZipTableBuilder(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276866.sst) /dev/shm/ToplingTemp/Topling-163467-dWbXAM 2024/11/23-19:18:31.194956 139957273912896 [top_zip_table_builder.cc:1352] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276866.sst): first pass time = 1.01's, 133.380'MB/sec 2024/11/23-19:18:32.511756 139957273912896 [top_zip_table_builder.cc:2772] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276866.sst): old prealloc_size = 147639500, real_size = 32192896 2024/11/23-19:18:32.512379 139957273912896 [top_zip_table_builder.cc:1773] BuildReorderMap(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276866.sst): index type = NestLoudsTrieDAWG_Mixed_XL_256_32_FL, store type = DictZipBlobStore usrkeys = 934119 prefix = 4 raw-key = 0.0149 GB zip-key = 0.0018 GB avg-key = 16.00 avg-zkey = 1.91 raw-val = 0.1081 GB zip-val = 0.0302 GB avg-val = 115.68 avg-zval = 32.30 2024/11/23-19:18:32.513149 139957273912896 [top_zip_table_builder.cc:1299] /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276866.sst: sumWaitingMem = 0.002 GB, sumWorkingMem = 0.000 GB, reorder workingMem = 0.0023 GB, waited 0.000 sec, Key+Value = 0.134 GB 2024/11/23-19:18:33.362654 139957273912896 [top_zip_table_builder.cc:3100] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276866.sst): second pass time = 1.32's, 82.113'MB/sec, value only(80.5% of KV) wait indexing time = 0.00's, remap KeyValue time = 0.85's, 42.545'MB/sec (all stages of remap) Get OrderMap time = 0.00's, 2978.648'MB/sec (index lex order gen) rebuild zvType time = 0.72's, 0.323'MB/sec write SST data time = 0.13's, 285.819'MB/sec dict compress time = 4356233619.02's, 0.000'MB/sec z-dict build time = 0.00's, sample length = 1.079'MB, throughput = 35637.842'MB/sec zip my value time = 1.32's, unzip length = 0.108'GB zip my value throughput = 82.113'MB/sec zip pipeline throughput = 82.113'MB/sec entries = 934119 avg-key = 28.00 avg-zkey = 1.91 avg-val = 115.68 avg-zval = 32.30 usrkeys = 934119 avg-key = 20.00 avg-zkey = 1.91 avg-val = 122.68 avg-zval = 32.30 TagRS{ kinds = RS_Key0_Tag1 bytes = 0 } TagArray{ size = 934119 bytes = 3152672 } seq expand size = 6538833 multi value expand size = 0 cnt WriteAppend = 16 UnZipSize{ index = 0.0187 GB value = 0.1081 GB dict = 1.08 MB all = 0.1342 GB } __ZipSize{ index = 0.0018 GB value = 0.0302 GB dict = 1.08 MB all = 0.0362 GB } UnZip/Zip{ index = 10.4471 value = 3.5817 dict = 1.00 all = 3.7077 } Zip/UnZip{ index = 0.0957 value = 0.2792 dict = 1.00 all = 0.2697 } ---------------------------- total value len = 9.192742 GB avg = 0.167 KB (by entry num) total key len = 1.518862 GB avg = 0.028 KB total ukey len = 1.053622 GB avg = 0.015 KB total ukey num = 0.068337626 Billion total entry num = 0.055145355 Billion write speed all = 0.286397745 MB/sec (with seq num) write speed all = 0.274602310 MB/sec (without seq num) 2024/11/23-19:18:33.407735 139957273912896 [compaction_job.cc:1948] [default] [JOB 34030] Generated table #276866: 934119 keys, 36200124 bytes, temperature: kWarm 2024/11/23-19:18:33.407807 139957273912896 EVENT_LOG_v1 {"time_micros": 1732360713407771, "cf_name": "default", "job": 34030, "event": "table_file_creation", "file_number": 276866, "file_size": 36200124, "file_checksum": "", "file_checksum_func_name": "Unknown", "smallest_seqno": 4137892167, "largest_seqno": 4210213365, "table_properties": {"data_size": 30170864, "index_size": 1788288, "index_partitions": 0, "top_level_index_size": 0, "index_key_is_user_key": 0, "index_value_is_delta_encoded": 0, "filter_size": 0, "raw_key_size": 26155332, "raw_average_key_size": 28, "raw_value_size": 108062402, "raw_average_value_size": 115, "num_data_blocks": 1, "num_entries": 934119, "num_filter_entries": 0, "num_deletions": 0, "num_merge_operands": 0, "num_range_deletions": 0, "format_version": 0, "fixed_key_len": 28, "fixed_value_len": 18446744073709551615, "filter_policy": "", "column_family_name": "default", "column_family_id": 0, "comparator": "leveldb.BytewiseComparator", "merge_operator": "nullptr", "prefix_extractor_name": "nullptr", "property_collectors": "[Rdb_tbl_prop_coll_factory]", "compression": "FlatZip", "compression_options": "RS_Key0_Tag1-NestLoudsTrieDAWG_Mixed_XL_256_32_FL-DictZipBlobStore", "creation_time": 1732360710, "oldest_key_time": 0, "file_creation_time": 1732360710, "slow_compression_estimated_data_size": 0, "fast_compression_estimated_data_size": 0, "db_id": "d89b4006-2803-486e-b7a2-759bcf348921", "db_session_id": "U1ECJGOXSO4Y1P7ZZXV1", "orig_file_number": 276866, "seqno_to_time_mapping": "N/A", "__indexstats__": "[...1 records...]"}} 2024/11/23-19:18:33.445192 139957273912896 [top_zip_table_builder.cc:934] ToplingZipTableBuilder(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276867.sst) /dev/shm/ToplingTemp/Topling-163467-fRa4cO 2024/11/23-19:18:34.418563 139957273912896 [top_zip_table_builder.cc:1352] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276867.sst): first pass time = 0.97's, 137.897'MB/sec 2024/11/23-19:18:35.725707 139957273912896 [top_zip_table_builder.cc:2772] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276867.sst): old prealloc_size = 147639500, real_size = 32947088 2024/11/23-19:18:35.726255 139957273912896 [top_zip_table_builder.cc:1773] BuildReorderMap(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276867.sst): index type = NestLoudsTrieDAWG_Mixed_XL_256_32_FL, store type = DictZipBlobStore usrkeys = 934438 prefix = 4 raw-key = 0.0150 GB zip-key = 0.0018 GB avg-key = 16.00 avg-zkey = 1.91 raw-val = 0.1081 GB zip-val = 0.0309 GB avg-val = 115.63 avg-zval = 33.09 2024/11/23-19:18:35.727026 139957273912896 [top_zip_table_builder.cc:1299] /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276867.sst: sumWaitingMem = 0.002 GB, sumWorkingMem = 0.000 GB, reorder workingMem = 0.0023 GB, waited 0.000 sec, Key+Value = 0.134 GB 2024/11/23-19:18:36.574769 139957273912896 [top_zip_table_builder.cc:3100] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276867.sst): second pass time = 1.31's, 82.722'MB/sec, value only(80.5% of KV) wait indexing time = 0.00's, remap KeyValue time = 0.85's, 43.521'MB/sec (all stages of remap) Get OrderMap time = 0.00's, 3378.348'MB/sec (index lex order gen) rebuild zvType time = 0.72's, 0.324'MB/sec write SST data time = 0.13's, 289.081'MB/sec dict compress time = 4356233619.02's, 0.000'MB/sec z-dict build time = 0.00's, sample length = 1.078'MB, throughput = 33553.536'MB/sec zip my value time = 1.31's, unzip length = 0.108'GB zip my value throughput = 82.722'MB/sec zip pipeline throughput = 82.722'MB/sec entries = 934438 avg-key = 28.00 avg-zkey = 1.91 avg-val = 115.63 avg-zval = 33.09 usrkeys = 934438 avg-key = 20.00 avg-zkey = 1.91 avg-val = 122.63 avg-zval = 33.09 TagRS{ kinds = RS_Key0_Tag1 bytes = 0 } TagArray{ size = 934438 bytes = 3153744 } seq expand size = 6541066 multi value expand size = 0 cnt WriteAppend = 13 UnZipSize{ index = 0.0187 GB value = 0.1081 GB dict = 1.08 MB all = 0.1342 GB } __ZipSize{ index = 0.0018 GB value = 0.0309 GB dict = 1.08 MB all = 0.0370 GB } UnZip/Zip{ index = 10.4439 value = 3.4942 dict = 1.00 all = 3.6323 } Zip/UnZip{ index = 0.0957 value = 0.2862 dict = 1.00 all = 0.2753 } ---------------------------- total value len = 9.307337 GB avg = 0.166 KB (by entry num) total key len = 1.545027 GB avg = 0.028 KB total ukey len = 1.072311 GB avg = 0.015 KB total ukey num = 0.069272064 Billion total entry num = 0.056079793 Billion write speed all = 0.290136319 MB/sec (with seq num) write speed all = 0.278142040 MB/sec (without seq num) 2024/11/23-19:18:36.621009 139957273912896 [compaction_job.cc:1948] [default] [JOB 34030] Generated table #276867: 934438 keys, 36950984 bytes, temperature: kWarm 2024/11/23-19:18:36.621089 139957273912896 EVENT_LOG_v1 {"time_micros": 1732360716621050, "cf_name": "default", "job": 34030, "event": "table_file_creation", "file_number": 276867, "file_size": 36950984, "file_checksum": "", "file_checksum_func_name": "Unknown", "smallest_seqno": 4124223986, "largest_seqno": 4210214308, "table_properties": {"data_size": 30923840, "index_size": 1789440, "index_partitions": 0, "top_level_index_size": 0, "index_key_is_user_key": 0, "index_value_is_delta_encoded": 0, "filter_size": 0, "raw_key_size": 26164264, "raw_average_key_size": 28, "raw_value_size": 108053584, "raw_average_value_size": 115, "num_data_blocks": 1, "num_entries": 934438, "num_filter_entries": 0, "num_deletions": 0, "num_merge_operands": 0, "num_range_deletions": 0, "format_version": 0, "fixed_key_len": 28, "fixed_value_len": 18446744073709551615, "filter_policy": "", "column_family_name": "default", "column_family_id": 0, "comparator": "leveldb.BytewiseComparator", "merge_operator": "nullptr", "prefix_extractor_name": "nullptr", "property_collectors": "[Rdb_tbl_prop_coll_factory]", "compression": "FlatZip", "compression_options": "RS_Key0_Tag1-NestLoudsTrieDAWG_Mixed_XL_256_32_FL-DictZipBlobStore", "creation_time": 1732360713, "oldest_key_time": 0, "file_creation_time": 1732360713, "slow_compression_estimated_data_size": 0, "fast_compression_estimated_data_size": 0, "db_id": "d89b4006-2803-486e-b7a2-759bcf348921", "db_session_id": "U1ECJGOXSO4Y1P7ZZXV1", "orig_file_number": 276867, "seqno_to_time_mapping": "N/A", "__indexstats__": "[...1 records...]"}} 2024/11/23-19:18:36.656889 139957273912896 [top_zip_table_builder.cc:934] ToplingZipTableBuilder(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276868.sst) /dev/shm/ToplingTemp/Topling-163467-2sAn0L 2024/11/23-19:18:37.620350 139957273912896 [top_zip_table_builder.cc:1352] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276868.sst): first pass time = 0.96's, 139.314'MB/sec 2024/11/23-19:18:38.957847 139957273912896 [top_zip_table_builder.cc:2772] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276868.sst): old prealloc_size = 147639500, real_size = 34056512 2024/11/23-19:18:38.958430 139957273912896 [top_zip_table_builder.cc:1773] BuildReorderMap(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276868.sst): index type = NestLoudsTrieDAWG_Mixed_XL_256_32_FL, store type = DictZipBlobStore usrkeys = 932469 prefix = 4 raw-key = 0.0149 GB zip-key = 0.0018 GB avg-key = 16.00 avg-zkey = 1.90 raw-val = 0.1081 GB zip-val = 0.0320 GB avg-val = 115.94 avg-zval = 34.37 2024/11/23-19:18:38.959188 139957273912896 [top_zip_table_builder.cc:1299] /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276868.sst: sumWaitingMem = 0.002 GB, sumWorkingMem = 0.000 GB, reorder workingMem = 0.0023 GB, waited 0.000 sec, Key+Value = 0.134 GB 2024/11/23-19:18:39.803337 139957273912896 [top_zip_table_builder.cc:3100] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276868.sst): second pass time = 1.34's, 80.884'MB/sec, value only(80.5% of KV) wait indexing time = 0.00's, remap KeyValue time = 0.85's, 44.872'MB/sec (all stages of remap) Get OrderMap time = 0.00's, 3157.324'MB/sec (index lex order gen) rebuild zvType time = 0.72's, 0.325'MB/sec write SST data time = 0.13's, 299.175'MB/sec dict compress time = 4356233619.02's, 0.000'MB/sec z-dict build time = 0.00's, sample length = 1.078'MB, throughput = 33681.517'MB/sec zip my value time = 1.34's, unzip length = 0.108'GB zip my value throughput = 80.884'MB/sec zip pipeline throughput = 80.884'MB/sec entries = 932469 avg-key = 28.00 avg-zkey = 1.90 avg-val = 115.94 avg-zval = 34.37 usrkeys = 932469 avg-key = 20.00 avg-zkey = 1.90 avg-val = 122.94 avg-zval = 34.37 TagRS{ kinds = RS_Key0_Tag1 bytes = 0 } TagArray{ size = 932469 bytes = 3030544 } seq expand size = 6527283 multi value expand size = 0 cnt WriteAppend = 13 UnZipSize{ index = 0.0186 GB value = 0.1081 GB dict = 1.08 MB all = 0.1342 GB } __ZipSize{ index = 0.0018 GB value = 0.0320 GB dict = 1.08 MB all = 0.0379 GB } UnZip/Zip{ index = 10.5129 value = 3.3732 dict = 1.00 all = 3.5378 } Zip/UnZip{ index = 0.0951 value = 0.2965 dict = 1.00 all = 0.2827 } ---------------------------- total value len = 9.421973 GB avg = 0.165 KB (by entry num) total key len = 1.571136 GB avg = 0.028 KB total ukey len = 1.090960 GB avg = 0.016 KB total ukey num = 0.070204533 Billion total entry num = 0.057012262 Billion write speed all = 0.293873752 MB/sec (with seq num) write speed all = 0.281681089 MB/sec (without seq num) 2024/11/23-19:18:39.850896 139957273912896 [compaction_job.cc:1948] [default] [JOB 34030] Generated table #276868: 932469 keys, 37937870 bytes, temperature: kWarm 2024/11/23-19:18:39.850966 139957273912896 EVENT_LOG_v1 {"time_micros": 1732360719850929, "cf_name": "default", "job": 34030, "event": "table_file_creation", "file_number": 276868, "file_size": 37937870, "file_checksum": "", "file_checksum_func_name": "Unknown", "smallest_seqno": 4152787506, "largest_seqno": 4210214028, "table_properties": {"data_size": 32049264, "index_size": 1773952, "index_partitions": 0, "top_level_index_size": 0, "index_key_is_user_key": 0, "index_value_is_delta_encoded": 0, "filter_size": 0, "raw_key_size": 26109132, "raw_average_key_size": 28, "raw_value_size": 108108638, "raw_average_value_size": 115, "num_data_blocks": 1, "num_entries": 932469, "num_filter_entries": 0, "num_deletions": 0, "num_merge_operands": 0, "num_range_deletions": 0, "format_version": 0, "fixed_key_len": 28, "fixed_value_len": 18446744073709551615, "filter_policy": "", "column_family_name": "default", "column_family_id": 0, "comparator": "leveldb.BytewiseComparator", "merge_operator": "nullptr", "prefix_extractor_name": "nullptr", "property_collectors": "[Rdb_tbl_prop_coll_factory]", "compression": "FlatZip", "compression_options": "RS_Key0_Tag1-NestLoudsTrieDAWG_Mixed_XL_256_32_FL-DictZipBlobStore", "creation_time": 1732360716, "oldest_key_time": 0, "file_creation_time": 1732360716, "slow_compression_estimated_data_size": 0, "fast_compression_estimated_data_size": 0, "db_id": "d89b4006-2803-486e-b7a2-759bcf348921", "db_session_id": "U1ECJGOXSO4Y1P7ZZXV1", "orig_file_number": 276868, "seqno_to_time_mapping": "N/A", "__indexstats__": "[...1 records...]"}} 2024/11/23-19:18:39.887189 139957273912896 [top_zip_table_builder.cc:934] ToplingZipTableBuilder(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276869.sst) /dev/shm/ToplingTemp/Topling-163467-ZddMBP 2024/11/23-19:18:40.207309 139957273912896 [top_zip_table_builder.cc:1352] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276869.sst): first pass time = 0.32's, 240.893'MB/sec 2024/11/23-19:18:40.947938 139957273912896 [top_zip_table_builder.cc:2772] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276869.sst): old prealloc_size = 147639500, real_size = 19237440 2024/11/23-19:18:40.948343 139957273912896 [top_zip_table_builder.cc:1773] BuildReorderMap(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276869.sst): index type = NestLoudsTrieDAWG_Mixed_XL_256_32_FL, store type = DictZipBlobStore usrkeys = 531580 prefix = 4 raw-key = 0.0085 GB zip-key = 0.0010 GB avg-key = 16.00 avg-zkey = 1.93 raw-val = 0.0622 GB zip-val = 0.0181 GB avg-val = 117.04 avg-zval = 34.01 2024/11/23-19:18:40.948799 139957273912896 [top_zip_table_builder.cc:1299] /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276869.sst: sumWaitingMem = 0.001 GB, sumWorkingMem = 0.000 GB, reorder workingMem = 0.0013 GB, waited 0.000 sec, Key+Value = 0.077 GB 2024/11/23-19:18:41.443286 139957273912896 [top_zip_table_builder.cc:3100] ToplingZipTableBuilder::Finish(/storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00/276869.sst): second pass time = 0.74's, 84.092'MB/sec, value only(80.7% of KV) wait indexing time = 0.00's, remap KeyValue time = 0.50's, 43.325'MB/sec (all stages of remap) Get OrderMap time = 0.00's, 2829.795'MB/sec (index lex order gen) rebuild zvType time = 0.42's, 0.316'MB/sec write SST data time = 0.07's, 290.532'MB/sec dict compress time = 4356233619.02's, 0.000'MB/sec z-dict build time = 0.00's, sample length = 0.625'MB, throughput = 18213.768'MB/sec zip my value time = 0.74's, unzip length = 0.062'GB zip my value throughput = 84.092'MB/sec zip pipeline throughput = 84.092'MB/sec entries = 531580 avg-key = 28.00 avg-zkey = 1.93 avg-val = 117.04 avg-zval = 34.01 usrkeys = 531580 avg-key = 20.00 avg-zkey = 1.93 avg-val = 124.04 avg-zval = 34.01 TagRS{ kinds = RS_Key0_Tag1 bytes = 0 } TagArray{ size = 531580 bytes = 1727648 } seq expand size = 3721060 multi value expand size = 0 cnt WriteAppend = 13 UnZipSize{ index = 0.0106 GB value = 0.0622 GB dict = 0.63 MB all = 0.0771 GB } __ZipSize{ index = 0.0010 GB value = 0.0181 GB dict = 0.63 MB all = 0.0215 GB } UnZip/Zip{ index = 10.3695 value = 3.4414 dict = 1.00 all = 3.5928 } Zip/UnZip{ index = 0.0964 value = 0.2906 dict = 1.00 all = 0.2783 } ---------------------------- total value len = 9.487912 GB avg = 0.165 KB (by entry num) total key len = 1.586020 GB avg = 0.028 KB total ukey len = 1.101592 GB avg = 0.016 KB total ukey num = 0.070736113 Billion total entry num = 0.057543842 Billion write speed all = 0.296021390 MB/sec (with seq num) write speed all = 0.283715583 MB/sec (without seq num) 2024/11/23-19:18:41.472102 139957273912896 [compaction_job.cc:1948] [default] [JOB 34030] Generated table #276869: 531580 keys, 21460183 bytes, temperature: kWarm 2024/11/23-19:18:41.472168 139957273912896 EVENT_LOG_v1 {"time_micros": 1732360721472134, "cf_name": "default", "job": 34030, "event": "table_file_creation", "file_number": 276869, "file_size": 21460183, "file_checksum": "", "file_checksum_func_name": "Unknown", "smallest_seqno": 4166149257, "largest_seqno": 4210213893, "table_properties": {"data_size": 18079088, "index_size": 1025280, "index_partitions": 0, "top_level_index_size": 0, "index_key_is_user_key": 0, "index_value_is_delta_encoded": 0, "filter_size": 0, "raw_key_size": 14884240, "raw_average_key_size": 28, "raw_value_size": 62218132, "raw_average_value_size": 117, "num_data_blocks": 1, "num_entries": 531580, "num_filter_entries": 0, "num_deletions": 0, "num_merge_operands": 0, "num_range_deletions": 0, "format_version": 0, "fixed_key_len": 28, "fixed_value_len": 18446744073709551615, "filter_policy": "", "column_family_name": "default", "column_family_id": 0, "comparator": "leveldb.BytewiseComparator", "merge_operator": "nullptr", "prefix_extractor_name": "nullptr", "property_collectors": "[Rdb_tbl_prop_coll_factory]", "compression": "FlatZip", "compression_options": "RS_Key0_Tag1-NestLoudsTrieDAWG_Mixed_XL_256_32_FL-DictZipBlobStore", "creation_time": 1732360719, "oldest_key_time": 0, "file_creation_time": 1732360719, "slow_compression_estimated_data_size": 0, "fast_compression_estimated_data_size": 0, "db_id": "d89b4006-2803-486e-b7a2-759bcf348921", "db_session_id": "U1ECJGOXSO4Y1P7ZZXV1", "orig_file_number": 276869, "seqno_to_time_mapping": "N/A", "__indexstats__": "[...1 records...]"}} 2024/11/23-19:18:41.490347 139957273912896 [compaction_job.cc:703] job-34030: subcompact[0], size: 0.208896 G, files: /storage/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/mytopling/.rocksdb/job-34030/att-00 [276864,276865,276866,276867,276868,276869] 2024/11/23-19:18:41.536310 139957273912896 (Original Log Time 2024/11/23-19:18:23.290417) EVENT_LOG_v1 {"time_micros": 1732360703290391, "job": 34030, "event": "compaction_started", "compaction_reason": "FilesMarkedForCompaction", "files_L2": [276791], "files_L3": [276861, 276711, 276712, 276713, 276714, 276815], "score": 0.996435, "input_data_size": 230713901, "oldest_snapshot_seqno": 4210866455} 2024/11/23-19:18:41.536313 139957273912896 (Original Log Time 2024/11/23-19:18:41.532159) [compaction_job.cc:2022] [default] [JOB 34030] Compacted 1@2 + 6@3 files to L3 => 208895851 bytes 2024/11/23-19:18:41.536314 139957273912896 (Original Log Time 2024/11/23-19:18:41.536248) [compaction_job.cc:1224] [default] compacted to: files[0 0 0 6 0 0 0] max score 0.01, MB/sec: 12.7 rd, 11.5 wr, level 3, files in(1, 6) out(6 +0 blob) MB in(27.1, 192.9 +0.0 blob) out(199.2 +0.0 blob), read-write-amplify(15.5) write-amplify(7.3) OK, records in: 5275516, records dropped: 89838 output_compression: Snappy 2024/11/23-19:18:41.536321 139957273912896 (Original Log Time 2024/11/23-19:18:41.536291) EVENT_LOG_v1 {"time_micros": 1732360721536271, "cf": "default", "job": 34030, "event": "compaction_finished", "compaction_time_micros": 18199938, "compaction_time_cpu_micros": 7817112, "output_level": 3, "num_output_files": 6, "total_output_size": 208895851, "num_input_records": 5275516, "num_output_records": 5185678, "num_subcompactions": 1, "output_compression": "Snappy", "num_single_delete_mismatches": 0, "num_single_delete_fallthrough": 0, "file_write_nanos": 142403500, "file_range_sync_nanos": 0, "file_fsync_nanos": 4199, "file_prepare_write_nanos": 15751, "lsm_state": [0, 0, 0, 6, 0, 0, 0]} 2024/11/23-19:18:41.665687 139957273912896 DEBG dcompact_worker.cpp:240: HttpPost: 200 OK: url = http://nlb-7zny4kaa1poal01o64.cn-shenzhen.nlb.aliyuncs.com:8443, body = {"instanceId":"nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137","labourId":"","dbId":"d89b4006-2803-486e-b7a2-759bcf348921","dbStarts":1732256054,"starts":1732360703,"executesMs":18378,"compactionJobId":34030,"attempt":0,"compactionInputRawBytes":760948240,"compactionInputZipBytes":230713901,"compactionOutputRawBytes":0,"compactionOutputZipBytes":208895851,"headers":{"Accept":"*/*","Connection":"close","Host":"aliyun-topling-saas.topling.cn:18443","RemoteIp":"120.24.192.169","X-Forwarded-For":"120.24.192.169","region":"cn-shenzhen","token":"e6474c481bd4415abc537135cc03626b","instance-token":"e6474c481bd4415abc537135cc03626b","provider":"aliyun","CloudMarketInstanceId":"si-59c0ae5c955845588903","MeteringAssit":"","Transfer-Encoding":"chunked","traceparent":"00-bff99475e21648275a683140562c9e2c-c88cb86380816ea1-00"}}, response = 2024/11/23-19:18:41.665787 139957273912896 INFO dcompact_worker.cpp:1459: finish /worker/dcompact-log/nfs/i-wz9deglxdazgiryp6ltb_10.57.5.137/2024-11-22T14.14.14/.rocksdb/job-34030/att-00: olev 3, work 18.379 s, result 7.646 ms, install 4.178 ms, input{raw 725.697 MiB zip 220.026 MiB}