2026-01-08 02:55:35,795 - INFO - ya.test.2361227  - pytest_runtest_setup: ####################################################################################################
2026-01-08 02:55:35,797 - INFO - ya.test.2361227  - pytest_runtest_setup: test_cluster_backup
2026-01-08 02:55:35,797 - INFO - ya.test.2361227  - pytest_runtest_setup: ####################################################################################################
2026-01-08 02:55:35,797 - INFO - ya.test.2361227  - pytest_runtest_setup: Test setup
2026-01-08 02:55:35,842 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd
2026-01-08 02:55:35,843 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/17567
2026-01-08 02:55:35,844 - DEBUG - ydb.tests.library.harness.kikimr_runner.2361227  - start: Working directory: /home/runner/.ya/build/build_root/pp6n/00348d/r3tmp/kikimr_cluster_mn68caoz
2026-01-08 02:55:35,868 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd
2026-01-08 02:55:35,868 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/22822
2026-01-08 02:55:35,868 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/25464
2026-01-08 02:55:35,869 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/13609
2026-01-08 02:55:35,869 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/28537
2026-01-08 02:55:35,869 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:35,870 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node=1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/node_1/logfile_we36t5k1.log --grpc-port=22822 --mon-port=25464 --ic-port=17567
2026-01-08 02:55:35,870 - DEBUG - ydb.tests.library.harness.kikimr_runner.2361227  - format_pdisk: Formatting pdisk SectorMap:1:64 on node localhost:22822/1, disk_size 68719476736
2026-01-08 02:55:35,870 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:35,870 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node=1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/node_1/logfile_we36t5k1.log --grpc-port=22822 --mon-port=25464 --ic-port=17567
2026-01-08 02:55:35,871 - DEBUG - ya.test.2361227  - execute: Executing '('/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', 'server', '--suppress-version-check', '--yaml-config=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs/config.yaml', '--node=1', '--log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/node_1/logfile_we36t5k1.log', '--grpc-port=22822', '--mon-port=25464', '--ic-port=17567')' in '/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/node_1' (no wait)
2026-01-08 02:55:35,872 - DEBUG - ya.test.2361227  - execute: Command pid: 2361393
2026-01-08 02:55:35,872 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Started node localhost:22822/1
2026-01-08 02:55:35,873 - DEBUG - ya.test.2361227  - _get_command_output_file: Command out will be placed to ydbd.out
2026-01-08 02:55:35,873 - DEBUG - ya.test.2361227  - _get_command_output_file: Command err will be placed to ydbd.err
2026-01-08 02:55:35,873 - DEBUG - ya.test.2361227  - execute: Executing '['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '-V']' in 'None' (waiting)
2026-01-08 02:55:35,874 - DEBUG - ya.test.2361227  - execute: Command pid: 2361394
2026-01-08 02:55:36,259 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) rc: 0
2026-01-08 02:55:36,259 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) elapsed time (sec): 0.38416266441345215
2026-01-08 02:55:36,259 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) idrss: 0
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) inblock: 0
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) isrss: 0
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) ixrss: 0
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) majflt: 0
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) maxrss: 556284
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) minflt: 16415
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) msgrcv: 0
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) msgsnd: 0
2026-01-08 02:55:36,260 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) nivcsw: 2
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) nsignals: 0
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) nswap: 0
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) nvcsw: 13
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) oublock: 8
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) stime: 0.236032
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) utime: 0.10001299999999999
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) wtime: 0.385
2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) output:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64

     
Build info:
    Compiler: /home/runner/.ya/tools/v4/10492077879/bin/clang++
    Compiler version: 
        clang version 20.1.8
        Target: x86_64-unknown-linux-gnu
        Thread model: posix
        InstalledDir: /home/runner/.ya/tools/v4/10492077879/bin
    Compile flags: -Xclang -fdebug-compilation-dir -Xclang /tmp -pipe -m64 -O3 -gline-tables-only -fno-common -ffunction-sections -fdata-sections -fsized-deallocation -fexceptions -fuse-init-array -fcolor-diagnostics -faligned-allocation -Werror -Wall -Wextra -Wno-parentheses -Wno-implicit-const-int-float-conversion -Wno-unknown-warning-option -D_THREAD_SAFE -D_PTHREADS -D_REENTRANT -D_LARGEFILE_SOURCE -D__STDC_CONSTANT_MACROS -D__STDC_FORMAT_MACROS -D_FILE_OFFSET_BITS=64 -D_GNU_SOURCE -D_YNDX_LIBUNWIND_ENABLE_EXCEPTION_BACKTRACE -D__LONG_LONG_SUPPORTED -fno-omit-frame-pointer -Wno-unknown-argument -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -DCATBOOST_OPENSOURCE=yes -msse2 -msse3 -mssse3 -msse4.1 -msse4.2 -mpopcnt -mcx16 -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -std=c++20 -Wimport-preprocessor-directive-pedantic -Woverloaded-virtual -Wno-ambiguous-reversed-operator -Wno-defaulted-function-deleted -Wno-deprecated-anon-enum-enum-conversion -Wno-deprecated-enum-enum-conversion -Wno-deprecated-enum-float-conversion -Wno-deprecated-volatile -Wno-pessimizing-move -Wno-undefined-var-template -nostdinc++ -DCATBOOST_OPENSOURCE=yes -nostdinc++

2026-01-08 02:55:36,261 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2361394) errors:

2026-01-08 02:55:36,262 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Node 1 version:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64
2026-01-08 02:55:38,002 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd
2026-01-08 02:55:38,002 - DEBUG - ydb.tests.library.harness.kikimr_runner.2361227  - __call_kikimr_new_cli: Executing command = ['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '--server', 'grpc://localhost:22822', 'admin', 'blobstorage', 'config', 'invoke', '--proto=Command {\n  DefineHostConfig {\n    HostConfigId: 1\n    Drive {\n      Path: "SectorMap:1:64"\n    }\n  }\n}\nCommand {\n  DefineBox {\n    BoxId: 1\n    Host {\n      Key {\n        Fqdn: "localhost"\n        IcPort: 17567\n      }\n      HostConfigId: 1\n    }\n  }\n}\n']
2026-01-08 02:55:38,003 - DEBUG - ya.test.2361227  - _get_command_output_file: Command out will be placed to ydbd.out.0
2026-01-08 02:55:38,003 - DEBUG - ya.test.2361227  - _get_command_output_file: Command err will be placed to ydbd.err.0
2026-01-08 02:55:38,003 - DEBUG - ya.test.2361227  - execute: Executing '['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '--server', 'grpc://localhost:22822', 'admin', 'blobstorage', 'config', 'invoke', '--proto=Command {\n  DefineHostConfig {\n    HostConfigId: 1\n    Drive {\n      Path: "SectorMap:1:64"\n    }\n  }\n}\nCommand {\n  DefineBox {\n    BoxId: 1\n    Host {\n      Key {\n        Fqdn: "localhost"\n        IcPort: 17567\n      }\n      HostConfigId: 1\n    }\n  }\n}\n']' in 'None' (waiting)
2026-01-08 02:55:38,004 - DEBUG - ya.test.2361227  - execute: Command pid: 2362212
2026-01-08 02:55:38,480 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) rc: 0
2026-01-08 02:55:38,480 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) elapsed time (sec): 0.47478389739990234
2026-01-08 02:55:38,480 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) idrss: 0
2026-01-08 02:55:38,481 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) inblock: 0
2026-01-08 02:55:38,481 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) isrss: 0
2026-01-08 02:55:38,481 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) ixrss: 0
2026-01-08 02:55:38,481 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) majflt: 0
2026-01-08 02:55:38,481 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) maxrss: 564724
2026-01-08 02:55:38,481 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) minflt: 18557
2026-01-08 02:55:38,482 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) msgrcv: 0
2026-01-08 02:55:38,482 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) msgsnd: 0
2026-01-08 02:55:38,482 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) nivcsw: 1
2026-01-08 02:55:38,482 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) nsignals: 0
2026-01-08 02:55:38,482 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) nswap: 0
2026-01-08 02:55:38,482 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) nvcsw: 142
2026-01-08 02:55:38,483 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) oublock: 8
2026-01-08 02:55:38,483 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) stime: 0.320556
2026-01-08 02:55:38,483 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) utime: 0.11080899999999999
2026-01-08 02:55:38,483 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) wtime: 0.476
2026-01-08 02:55:38,483 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) output:
Status {
  Success: true
}
Status {
  Success: true
}
Success: true
ConfigTxSeqNo: 4

2026-01-08 02:55:38,483 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362212) errors:

2026-01-08 02:55:38,484 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd
2026-01-08 02:55:38,485 - DEBUG - ydb.tests.library.harness.kikimr_runner.2361227  - __call_kikimr_new_cli: Executing command = ['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '--server', 'grpc://localhost:22822', 'admin', 'blobstorage', 'config', 'invoke', '--proto=Command {\n  DefineStoragePool {\n    BoxId: 1\n    StoragePoolId: 1\n    Name: "dynamic_storage_pool:1"\n    ErasureSpecies: "none"\n    VDiskKind: "Default"\n    Kind: "hdd"\n    NumGroups: 2\n    PDiskFilter {\n      Property {\n        Type: ROT\n      }\n      Property {\n        Kind: 0\n      }\n    }\n  }\n}\n']
2026-01-08 02:55:38,486 - DEBUG - ya.test.2361227  - _get_command_output_file: Command out will be placed to ydbd.out.1
2026-01-08 02:55:38,486 - DEBUG - ya.test.2361227  - _get_command_output_file: Command err will be placed to ydbd.err.1
2026-01-08 02:55:38,487 - DEBUG - ya.test.2361227  - execute: Executing '['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '--server', 'grpc://localhost:22822', 'admin', 'blobstorage', 'config', 'invoke', '--proto=Command {\n  DefineStoragePool {\n    BoxId: 1\n    StoragePoolId: 1\n    Name: "dynamic_storage_pool:1"\n    ErasureSpecies: "none"\n    VDiskKind: "Default"\n    Kind: "hdd"\n    NumGroups: 2\n    PDiskFilter {\n      Property {\n        Type: ROT\n      }\n      Property {\n        Kind: 0\n      }\n    }\n  }\n}\n']' in 'None' (waiting)
2026-01-08 02:55:38,488 - DEBUG - ya.test.2361227  - execute: Command pid: 2362455
2026-01-08 02:55:38,903 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) rc: 0
2026-01-08 02:55:38,903 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) elapsed time (sec): 0.41490697860717773
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) idrss: 0
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) inblock: 0
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) isrss: 0
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) ixrss: 0
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) majflt: 0
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) maxrss: 564724
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) minflt: 18559
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) msgrcv: 0
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) msgsnd: 0
2026-01-08 02:55:38,904 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) nivcsw: 1
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) nsignals: 0
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) nswap: 0
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) nvcsw: 146
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) oublock: 8
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) stime: 0.268333
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) utime: 0.102598
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) wtime: 0.416
2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) output:
Status {
  Success: true
}
Success: true
ConfigTxSeqNo: 5

2026-01-08 02:55:38,905 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362455) errors:

2026-01-08 02:55:38,906 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __run: Binding storage pools to domain Root: {'dynamic_storage_pool:1': 'hdd'}
2026-01-08 02:55:38,916 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __run: Cluster started and initialized
2026-01-08 02:55:39,435 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd
2026-01-08 02:55:39,435 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/2746
2026-01-08 02:55:39,436 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/23288
2026-01-08 02:55:39,436 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/15822
2026-01-08 02:55:39,437 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/13266
2026-01-08 02:55:39,437 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/5218
2026-01-08 02:55:39,438 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:39,438 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node-broker=localhost:22822 --tenant=/Root/db1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_1/logfile_kx8tsrsv.log --grpc-port=2746 --mon-port=23288 --ic-port=15822
2026-01-08 02:55:39,438 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd
2026-01-08 02:55:39,439 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/32284
2026-01-08 02:55:39,439 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/61838
2026-01-08 02:55:39,440 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/24183
2026-01-08 02:55:39,440 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/26336
2026-01-08 02:55:39,440 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/20672
2026-01-08 02:55:39,441 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:39,441 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node-broker=localhost:22822 --tenant=/Root/db1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_2/logfile_zqrery1p.log --grpc-port=32284 --mon-port=61838 --ic-port=24183
2026-01-08 02:55:39,442 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd
2026-01-08 02:55:39,442 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/20807
2026-01-08 02:55:39,442 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/8982
2026-01-08 02:55:39,442 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/7565
2026-01-08 02:55:39,443 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/63658
2026-01-08 02:55:39,443 - DEBUG - library.python.filelock.2361227  - acquire: Acquiring FileLock (blocking=False): /home/runner/.ya/build/port_sync_dir/10976
2026-01-08 02:55:39,444 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:39,444 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node-broker=localhost:22822 --tenant=/Root/db1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_3/logfile_s16w_tsy.log --grpc-port=20807 --mon-port=8982 --ic-port=7565
2026-01-08 02:55:39,444 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:39,445 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node-broker=localhost:22822 --tenant=/Root/db1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_1/logfile_kx8tsrsv.log --grpc-port=2746 --mon-port=23288 --ic-port=15822
2026-01-08 02:55:39,445 - DEBUG - ya.test.2361227  - execute: Executing '('/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', 'server', '--suppress-version-check', '--yaml-config=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs/config.yaml', '--node-broker=localhost:22822', '--tenant=/Root/db1', '--log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_1/logfile_kx8tsrsv.log', '--grpc-port=2746', '--mon-port=23288', '--ic-port=15822')' in '/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_1' (no wait)
2026-01-08 02:55:39,447 - DEBUG - ya.test.2361227  - execute: Command pid: 2362904
2026-01-08 02:55:39,447 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Started node localhost:2746/1
2026-01-08 02:55:39,448 - DEBUG - ya.test.2361227  - _get_command_output_file: Command out will be placed to ydbd.out.2
2026-01-08 02:55:39,448 - DEBUG - ya.test.2361227  - _get_command_output_file: Command err will be placed to ydbd.err.2
2026-01-08 02:55:39,449 - DEBUG - ya.test.2361227  - execute: Executing '['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '-V']' in 'None' (waiting)
2026-01-08 02:55:39,449 - DEBUG - ya.test.2361227  - execute: Command pid: 2362905
2026-01-08 02:55:39,875 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) rc: 0
2026-01-08 02:55:39,876 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) elapsed time (sec): 0.4254879951477051
2026-01-08 02:55:39,876 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) idrss: 0
2026-01-08 02:55:39,876 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) inblock: 0
2026-01-08 02:55:39,876 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) isrss: 0
2026-01-08 02:55:39,877 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) ixrss: 0
2026-01-08 02:55:39,877 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) majflt: 0
2026-01-08 02:55:39,877 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) maxrss: 556284
2026-01-08 02:55:39,877 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) minflt: 16415
2026-01-08 02:55:39,877 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) msgrcv: 0
2026-01-08 02:55:39,878 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) msgsnd: 0
2026-01-08 02:55:39,878 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) nivcsw: 2
2026-01-08 02:55:39,878 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) nsignals: 0
2026-01-08 02:55:39,878 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) nswap: 0
2026-01-08 02:55:39,878 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) nvcsw: 18
2026-01-08 02:55:39,878 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) oublock: 8
2026-01-08 02:55:39,879 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) stime: 0.300958
2026-01-08 02:55:39,879 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) utime: 0.07624199999999999
2026-01-08 02:55:39,879 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) wtime: 0.426
2026-01-08 02:55:39,879 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) output:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64

     
Build info:
    Compiler: /home/runner/.ya/tools/v4/10492077879/bin/clang++
    Compiler version: 
        clang version 20.1.8
        Target: x86_64-unknown-linux-gnu
        Thread model: posix
        InstalledDir: /home/runner/.ya/tools/v4/10492077879/bin
    Compile flags: -Xclang -fdebug-compilation-dir -Xclang /tmp -pipe -m64 -O3 -gline-tables-only -fno-common -ffunction-sections -fdata-sections -fsized-deallocation -fexceptions -fuse-init-array -fcolor-diagnostics -faligned-allocation -Werror -Wall -Wextra -Wno-parentheses -Wno-implicit-const-int-float-conversion -Wno-unknown-warning-option -D_THREAD_SAFE -D_PTHREADS -D_REENTRANT -D_LARGEFILE_SOURCE -D__STDC_CONSTANT_MACROS -D__STDC_FORMAT_MACROS -D_FILE_OFFSET_BITS=64 -D_GNU_SOURCE -D_YNDX_LIBUNWIND_ENABLE_EXCEPTION_BACKTRACE -D__LONG_LONG_SUPPORTED -fno-omit-frame-pointer -Wno-unknown-argument -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -DCATBOOST_OPENSOURCE=yes -msse2 -msse3 -mssse3 -msse4.1 -msse4.2 -mpopcnt -mcx16 -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -std=c++20 -Wimport-preprocessor-directive-pedantic -Woverloaded-virtual -Wno-ambiguous-reversed-operator -Wno-defaulted-function-deleted -Wno-deprecated-anon-enum-enum-conversion -Wno-deprecated-enum-enum-conversion -Wno-deprecated-enum-float-conversion -Wno-deprecated-volatile -Wno-pessimizing-move -Wno-undefined-var-template -nostdinc++ -DCATBOOST_OPENSOURCE=yes -nostdinc++

2026-01-08 02:55:39,879 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2362905) errors:

2026-01-08 02:55:39,880 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Node 1 version:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64
2026-01-08 02:55:39,880 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:39,880 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node-broker=localhost:22822 --tenant=/Root/db1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_2/logfile_zqrery1p.log --grpc-port=32284 --mon-port=61838 --ic-port=24183
2026-01-08 02:55:39,881 - DEBUG - ya.test.2361227  - execute: Executing '('/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', 'server', '--suppress-version-check', '--yaml-config=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs/config.yaml', '--node-broker=localhost:22822', '--tenant=/Root/db1', '--log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_2/logfile_zqrery1p.log', '--grpc-port=32284', '--mon-port=61838', '--ic-port=24183')' in '/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_2' (no wait)
2026-01-08 02:55:39,883 - DEBUG - ya.test.2361227  - execute: Command pid: 2363080
2026-01-08 02:55:39,883 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Started node localhost:32284/2
2026-01-08 02:55:39,885 - DEBUG - ya.test.2361227  - _get_command_output_file: Command out will be placed to ydbd.out.3
2026-01-08 02:55:39,885 - DEBUG - ya.test.2361227  - _get_command_output_file: Command err will be placed to ydbd.err.3
2026-01-08 02:55:39,885 - DEBUG - ya.test.2361227  - execute: Executing '['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '-V']' in 'None' (waiting)
2026-01-08 02:55:39,886 - DEBUG - ya.test.2361227  - execute: Command pid: 2363081
2026-01-08 02:55:40,246 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) rc: 0
2026-01-08 02:55:40,246 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) elapsed time (sec): 0.35908031463623047
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) idrss: 0
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) inblock: 0
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) isrss: 0
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) ixrss: 0
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) majflt: 0
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) maxrss: 556284
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) minflt: 16417
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) msgrcv: 0
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) msgsnd: 0
2026-01-08 02:55:40,247 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) nivcsw: 0
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) nsignals: 0
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) nswap: 0
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) nvcsw: 13
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) oublock: 8
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) stime: 0.21923399999999998
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) utime: 0.091665
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) wtime: 0.36
2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) output:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64

     
Build info:
    Compiler: /home/runner/.ya/tools/v4/10492077879/bin/clang++
    Compiler version: 
        clang version 20.1.8
        Target: x86_64-unknown-linux-gnu
        Thread model: posix
        InstalledDir: /home/runner/.ya/tools/v4/10492077879/bin
    Compile flags: -Xclang -fdebug-compilation-dir -Xclang /tmp -pipe -m64 -O3 -gline-tables-only -fno-common -ffunction-sections -fdata-sections -fsized-deallocation -fexceptions -fuse-init-array -fcolor-diagnostics -faligned-allocation -Werror -Wall -Wextra -Wno-parentheses -Wno-implicit-const-int-float-conversion -Wno-unknown-warning-option -D_THREAD_SAFE -D_PTHREADS -D_REENTRANT -D_LARGEFILE_SOURCE -D__STDC_CONSTANT_MACROS -D__STDC_FORMAT_MACROS -D_FILE_OFFSET_BITS=64 -D_GNU_SOURCE -D_YNDX_LIBUNWIND_ENABLE_EXCEPTION_BACKTRACE -D__LONG_LONG_SUPPORTED -fno-omit-frame-pointer -Wno-unknown-argument -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -DCATBOOST_OPENSOURCE=yes -msse2 -msse3 -mssse3 -msse4.1 -msse4.2 -mpopcnt -mcx16 -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -std=c++20 -Wimport-preprocessor-directive-pedantic -Woverloaded-virtual -Wno-ambiguous-reversed-operator -Wno-defaulted-function-deleted -Wno-deprecated-anon-enum-enum-conversion -Wno-deprecated-enum-enum-conversion -Wno-deprecated-enum-float-conversion -Wno-deprecated-volatile -Wno-pessimizing-move -Wno-undefined-var-template -nostdinc++ -DCATBOOST_OPENSOURCE=yes -nostdinc++

2026-01-08 02:55:40,248 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363081) errors:

2026-01-08 02:55:40,249 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Node 2 version:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64
2026-01-08 02:55:40,249 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: CFG_DIR_PATH="/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs"
2026-01-08 02:55:40,249 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - __make_run_command: Final command: /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd server --suppress-version-check --yaml-config=$CFG_DIR_PATH/config.yaml --node-broker=localhost:22822 --tenant=/Root/db1 --log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_3/logfile_s16w_tsy.log --grpc-port=20807 --mon-port=8982 --ic-port=7565
2026-01-08 02:55:40,250 - DEBUG - ya.test.2361227  - execute: Executing '('/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', 'server', '--suppress-version-check', '--yaml-config=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/kikimr_configs/config.yaml', '--node-broker=localhost:22822', '--tenant=/Root/db1', '--log-file-name=/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_3/logfile_s16w_tsy.log', '--grpc-port=20807', '--mon-port=8982', '--ic-port=7565')' in '/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_3' (no wait)
2026-01-08 02:55:40,251 - DEBUG - ya.test.2361227  - execute: Command pid: 2363391
2026-01-08 02:55:40,251 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Started node localhost:20807/3
2026-01-08 02:55:40,252 - DEBUG - ya.test.2361227  - _get_command_output_file: Command out will be placed to ydbd.out.4
2026-01-08 02:55:40,252 - DEBUG - ya.test.2361227  - _get_command_output_file: Command err will be placed to ydbd.err.4
2026-01-08 02:55:40,252 - DEBUG - ya.test.2361227  - execute: Executing '['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydbd/ydbd', '-V']' in 'None' (waiting)
2026-01-08 02:55:40,252 - DEBUG - ya.test.2361227  - execute: Command pid: 2363397
2026-01-08 02:55:40,634 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) rc: 0
2026-01-08 02:55:40,635 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) elapsed time (sec): 0.3744642734527588
2026-01-08 02:55:40,635 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) idrss: 0
2026-01-08 02:55:40,635 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) inblock: 0
2026-01-08 02:55:40,635 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) isrss: 0
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) ixrss: 0
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) majflt: 0
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) maxrss: 556284
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) minflt: 16425
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) msgrcv: 0
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) msgsnd: 0
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) nivcsw: 4
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) nsignals: 0
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) nswap: 0
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) nvcsw: 14
2026-01-08 02:55:40,636 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) oublock: 8
2026-01-08 02:55:40,637 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) stime: 0.22265
2026-01-08 02:55:40,637 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) utime: 0.10337299999999999
2026-01-08 02:55:40,637 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) wtime: 0.375
2026-01-08 02:55:40,637 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) output:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64

     
Build info:
    Compiler: /home/runner/.ya/tools/v4/10492077879/bin/clang++
    Compiler version: 
        clang version 20.1.8
        Target: x86_64-unknown-linux-gnu
        Thread model: posix
        InstalledDir: /home/runner/.ya/tools/v4/10492077879/bin
    Compile flags: -Xclang -fdebug-compilation-dir -Xclang /tmp -pipe -m64 -O3 -gline-tables-only -fno-common -ffunction-sections -fdata-sections -fsized-deallocation -fexceptions -fuse-init-array -fcolor-diagnostics -faligned-allocation -Werror -Wall -Wextra -Wno-parentheses -Wno-implicit-const-int-float-conversion -Wno-unknown-warning-option -D_THREAD_SAFE -D_PTHREADS -D_REENTRANT -D_LARGEFILE_SOURCE -D__STDC_CONSTANT_MACROS -D__STDC_FORMAT_MACROS -D_FILE_OFFSET_BITS=64 -D_GNU_SOURCE -D_YNDX_LIBUNWIND_ENABLE_EXCEPTION_BACKTRACE -D__LONG_LONG_SUPPORTED -fno-omit-frame-pointer -Wno-unknown-argument -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -DCATBOOST_OPENSOURCE=yes -msse2 -msse3 -mssse3 -msse4.1 -msse4.2 -mpopcnt -mcx16 -UNDEBUG -Wno-array-parameter -Wno-deprecate-lax-vec-conv-all -Wno-unqualified-std-cast-call -Wno-unused-but-set-parameter -Wno-implicit-function-declaration -Wno-int-conversion -Wno-incompatible-function-pointer-types -Wno-address-of-packed-member -Wno-deprecated-this-capture -Wno-missing-designated-field-initializers -Wno-format -Wno-vla-cxx-extension -Wno-invalid-offsetof -Wno-alias-template-in-declaration-name -Wno-cast-function-type-mismatch -Wno-explicit-specialization-storage-class -Wno-extraneous-template-head -Wno-missing-template-arg-list-after-template-kw -Wno-nontrivial-memcall -Wno-strict-primary-template-shadow -std=c++20 -Wimport-preprocessor-directive-pedantic -Woverloaded-virtual -Wno-ambiguous-reversed-operator -Wno-defaulted-function-deleted -Wno-deprecated-anon-enum-enum-conversion -Wno-deprecated-enum-enum-conversion -Wno-deprecated-enum-float-conversion -Wno-deprecated-volatile -Wno-pessimizing-move -Wno-undefined-var-template -nostdinc++ -DCATBOOST_OPENSOURCE=yes -nostdinc++

2026-01-08 02:55:40,637 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2363397) errors:

2026-01-08 02:55:40,638 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - start: Node 3 version:
Git info:
    Commit: 2498974ca152b7a4dd22679e7971857d09904db4
    Branch: 
    Author: Hor911 <hor911@ydb.tech>
    Summary: Merge 7aca38f946c83b69d6e02768574adc4e08ea0f50 into 05744b79f6132ebbd8de22eb67c4ad9b1d5acbde
Other info:
    Build by: runner
    Top src dir: /home/runner/actions_runner/_work/ydb/ydb
    Top build dir: /home/runner/.ya/build
    Hostname: ghrun-paw7opzmb4    Host information: 
        Linux ghrun-paw7opzmb4 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64
2026-01-08 02:57:26,708 - DEBUG - ydb.connection.2361227  - channel_factory: Channel options: [('grpc.max_receive_message_length', 64000000), ('grpc.max_send_message_length', 64000000), ('grpc.primary_user_agent', 'python-library'), ('grpc.lb_policy_name', 'round_robin'), ('grpc.keepalive_time_ms', 10000), ('grpc.keepalive_timeout_ms', 10000), ('grpc.http2.max_pings_without_data', 0), ('grpc.keepalive_permit_without_calls', 0)]
2026-01-08 02:57:26,711 - DEBUG - ydb.resolver.DiscoveryEndpointsResolver.2361227  - context_resolve: Preparing initial endpoint to resolve endpoints
2026-01-08 02:57:26,712 - DEBUG - ydb.connection.2361227  - channel_factory: Channel options: [('grpc.max_receive_message_length', 64000000), ('grpc.max_send_message_length', 64000000), ('grpc.primary_user_agent', 'python-library'), ('grpc.lb_policy_name', 'round_robin'), ('grpc.keepalive_time_ms', 10000), ('grpc.keepalive_timeout_ms', 10000), ('grpc.http2.max_pings_without_data', 0), ('grpc.keepalive_permit_without_calls', 0)]
2026-01-08 02:57:26,721 - DEBUG - ydb.resolver.DiscoveryEndpointsResolver.2361227  - context_resolve: Resolving endpoints for database /Root/db1
2026-01-08 02:57:26,722 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ListEndpoints, 4eff34ed-f17e-4391-82b9-3efccc9e99de, localhost:22822): creating call state
2026-01-08 02:57:26,722 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ListEndpoints, 4eff34ed-f17e-4391-82b9-3efccc9e99de, localhost:22822): request = { database: "/Root/db1" }
2026-01-08 02:57:26,724 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ListEndpoints, 4eff34ed-f17e-4391-82b9-3efccc9e99de, localhost:22822): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Discovery.ListEndpointsResult] { endpoints { address: "ghrun-paw7opzmb4.auto.internal" port: 32284 service: "legacy" service: "tablet_service" service: "yql" service: "discovery" service: "cms" service: "locking" service: "kesus" service: "pq" service: "pqcd" service: "pqv1" service: "topic" service: "datastreams" service: "scripting" service: "clickhouse_internal" service: "rate_limiter" service: "analytics" service: "export" service: "import" service: "yq" service: "keyvalue" service: "monitoring" service: "auth" service: "query_service" service: "view" node_id: 50001 } self_location: "1" } } } }
2026-01-08 02:57:26,725 - DEBUG - ydb.resolver.DiscoveryEndpointsResolver.2361227  - _add_debug_details: Resolved endpoints for database /Root/db1: DiscoveryResult <self_location: 1, endpoints [<Endpoint ghrun-paw7opzmb4.auto.internal:32284, location , ssl: False>]>
2026-01-08 02:57:26,725 - DEBUG - ydb.connection.2361227  - channel_factory: Channel options: [('grpc.max_receive_message_length', 64000000), ('grpc.max_send_message_length', 64000000), ('grpc.primary_user_agent', 'python-library'), ('grpc.lb_policy_name', 'round_robin'), ('grpc.keepalive_time_ms', 10000), ('grpc.keepalive_timeout_ms', 10000), ('grpc.http2.max_pings_without_data', 0), ('grpc.keepalive_permit_without_calls', 0)]
2026-01-08 02:57:26,731 - INFO - ya.test.2361227  - pytest_runtest_call: Test call (class_name: test_ydb_backup.py::TestClusterBackup, test_name: test_cluster_backup)
2026-01-08 02:57:26,732 - DEBUG - ydb.table.SessionPool.2361227  - subscribe: Active session queue is empty, subscribe waiter for a session
2026-01-08 02:57:26,732 - DEBUG - ydb.table.SessionPool.2361227  - subscribe: Subscribe waiter <Future at 0x7f4554bc95f0 state=pending>
2026-01-08 02:57:26,732 - DEBUG - ydb.table.SessionPool.2361227  - subscribe: Session pool is not large enough (active_count < size: 0 < 100). will create a new session.
2026-01-08 02:57:26,733 - DEBUG - ydb.table.SessionPool.2361227  - _create: Created session <ydb.table.Session object at 0x7f4554bcd280>
2026-01-08 02:57:26,733 - DEBUG - ydb.table.SessionPool.2361227  - _prepare: Preparing session <ydb.table.Session object at 0x7f4554bcd280>
2026-01-08 02:57:26,733 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(CreateSession, a4683e10-caef-4685-ae38-b5d419744658, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,734 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(CreateSession, a4683e10-caef-4685-ae38-b5d419744658, ghrun-paw7opzmb4.auto.internal:32284): request = { operation_params { operation_timeout { seconds: 3 } cancel_after { seconds: 3 } } }
2026-01-08 02:57:26,735 - DEBUG - ydb.connection.2361227  - _on_response_callback: RpcState(CreateSession, a4683e10-caef-4685-ae38-b5d419744658, ghrun-paw7opzmb4.auto.internal:32284): on response callback started
2026-01-08 02:57:26,736 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(CreateSession, a4683e10-caef-4685-ae38-b5d419744658, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.CreateSessionResult] { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" } } } }
2026-01-08 02:57:26,736 - DEBUG - ydb.table.SessionPool.2361227  - put: Put on session <ydb.table.Session object at 0x7f4554bcd280>
2026-01-08 02:57:26,736 - DEBUG - ydb.table.SessionPool.2361227  - put: Replying to waiter with a session <ydb.table.Session object at 0x7f4554bcd280>
2026-01-08 02:57:26,737 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, 3c309517-43d4-440c-a7c4-640e3ea74e17, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,737 - DEBUG - ydb.connection.2361227  - _on_response_callback: RpcState(CreateSession, a4683e10-caef-4685-ae38-b5d419744658, ghrun-paw7opzmb4.auto.internal:32284): on response callback success
2026-01-08 02:57:26,737 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, 3c309517-43d4-440c-a7c4-640e3ea74e17, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "CREATE GROUP people" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,743 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, 3c309517-43d4-440c-a7c4-640e3ea74e17, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,744 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, 52410b95-ff63-406f-88d4-a72322598660, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,744 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, 52410b95-ff63-406f-88d4-a72322598660, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "CREATE USER alice PASSWORD \'1234\'" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,755 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, 52410b95-ff63-406f-88d4-a72322598660, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,755 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, d13ffaea-df2c-40d5-b9e0-f79ce38a6a96, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,755 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, d13ffaea-df2c-40d5-b9e0-f79ce38a6a96, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "CREATE USER bob PASSWORD \'1234\'" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,765 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, d13ffaea-df2c-40d5-b9e0-f79ce38a6a96, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,766 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, c4451a26-1bc1-4da9-8028-f706d5ed4693, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,766 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, c4451a26-1bc1-4da9-8028-f706d5ed4693, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "ALTER GROUP people ADD USER alice" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,770 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, c4451a26-1bc1-4da9-8028-f706d5ed4693, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,771 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, da4bee4a-d2e4-4ec1-8c1d-47e8728ec5db, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,771 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, da4bee4a-d2e4-4ec1-8c1d-47e8728ec5db, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "ALTER GROUP people ADD USER bob" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,775 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, da4bee4a-d2e4-4ec1-8c1d-47e8728ec5db, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,775 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, 16e5b22b-2492-4ac7-b074-0c10c1dfa655, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,776 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, 16e5b22b-2492-4ac7-b074-0c10c1dfa655, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "CREATE GROUP dbadmins" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,779 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, 16e5b22b-2492-4ac7-b074-0c10c1dfa655, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,779 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, 5e8edc3a-85e6-48b0-bc15-78acc569c4db, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,780 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, 5e8edc3a-85e6-48b0-bc15-78acc569c4db, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "CREATE USER dbadmin1" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,785 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, 5e8edc3a-85e6-48b0-bc15-78acc569c4db, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,785 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, c5b8698c-9394-47e5-ac44-6a526e64f946, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,785 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, c5b8698c-9394-47e5-ac44-6a526e64f946, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "CREATE USER dbadmin2 PASSWORD \'1234\'" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,795 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, c5b8698c-9394-47e5-ac44-6a526e64f946, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,795 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, 492a6c7e-82cd-4443-a121-82f1a0d7187f, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,795 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, 492a6c7e-82cd-4443-a121-82f1a0d7187f, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "ALTER GROUP dbadmins ADD USER dbadmin1" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,799 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, 492a6c7e-82cd-4443-a121-82f1a0d7187f, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,799 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, fbb8d87d-a460-44bd-990d-f89ecc187274, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,800 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, fbb8d87d-a460-44bd-990d-f89ecc187274, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "ALTER GROUP dbadmins ADD USER dbadmin2" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,803 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, fbb8d87d-a460-44bd-990d-f89ecc187274, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,803 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteSchemeQuery, 55907a48-589e-4302-9372-d202d4a457f0, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,804 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteSchemeQuery, 55907a48-589e-4302-9372-d202d4a457f0, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=YTFmZDFjNTAtOGJjYWFjZTktZjdkYjU5ODctZmQzMzBhZDY=" yql_text: "GRANT \"ydb.generic.use\" on `/Root/db1` TO dbadmins" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,807 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteSchemeQuery, 55907a48-589e-4302-9372-d202d4a457f0, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,808 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ModifyPermissions, ba741004-4800-4c58-a41a-a7b27eefb802, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,808 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ModifyPermissions, ba741004-4800-4c58-a41a-a7b27eefb802, ghrun-paw7opzmb4.auto.internal:32284): request = { operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } path: "/Root/db1" actions { change_owner: "dbadmins" } }
2026-01-08 02:57:26,809 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ModifyPermissions, ba741004-4800-4c58-a41a-a7b27eefb802, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,810 - DEBUG - ydb.table.SessionPool.2361227  - put: Put on session <ydb.table.Session object at 0x7f4554bcd280>
2026-01-08 02:57:26,810 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(CreateSession, 581e8f1d-c974-4178-babd-1b440ee2c3ca, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,810 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(CreateSession, 581e8f1d-c974-4178-babd-1b440ee2c3ca, ghrun-paw7opzmb4.auto.internal:32284): request = { operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,811 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(CreateSession, 581e8f1d-c974-4178-babd-1b440ee2c3ca, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.CreateSessionResult] { session_id: "ydb://session/3?node_id=50001&id=NjcxOGIyYTAtOTZhZWMwZmQtY2E2MzkzMWItN2IwNjY5Yjg=" } } } }
2026-01-08 02:57:26,812 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(CreateTable, b7dd9dd4-4c54-43e0-bbde-bc09bd4cbbf9, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,812 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(CreateTable, b7dd9dd4-4c54-43e0-bbde-bc09bd4cbbf9, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=NjcxOGIyYTAtOTZhZWMwZmQtY2E2MzkzMWItN2IwNjY5Yjg=" path: "/Root/db1/table" columns { name: "id" type { optional_type { item { type_id: UINT32 } } } } columns { name: "number" type { optional_type { item { type_id: UINT64 } } } } columns { name: "string" type { optional_type { item { type_id: STRING } } } } columns { name: "fixed_point" type { optional_type { item { decimal_type { precision: 22 scale: 9 } } } } } primary_key: "id" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,830 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(CreateTable, b7dd9dd4-4c54-43e0-bbde-bc09bd4cbbf9, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS } }
2026-01-08 02:57:26,831 - DEBUG - ydb.connection.2361227  - _prepare_call: RpcState(ExecuteDataQuery, 923b024c-bf51-4ad1-881a-d0ae5a1f80e5, ghrun-paw7opzmb4.auto.internal:32284): creating call state
2026-01-08 02:57:26,832 - DEBUG - ydb.connection.2361227  - _log_request: RpcState(ExecuteDataQuery, 923b024c-bf51-4ad1-881a-d0ae5a1f80e5, ghrun-paw7opzmb4.auto.internal:32284): request = { session_id: "ydb://session/3?node_id=50001&id=NjcxOGIyYTAtOTZhZWMwZmQtY2E2MzkzMWItN2IwNjY5Yjg=" tx_control { begin_tx { serializable_read_write { } } commit_tx: true } query { yql_text: "\n        PRAGMA TablePathPrefix(\"/Root/db1\");\n        UPSERT INTO table (`id`, `number`, `string`, `fixed_point`) VALUES (2, 6,  \"pen\",       CAST(\"2.4\" AS Decimal(22,9)));\n        UPSERT INTO table (`id`,           `string`, `fixed_point`) VALUES (3,     \"pineapple\", CAST(\"3.5\" AS Decimal(22,9)));\n        UPSERT INTO table (`id`, `number`,          `fixed_point`) VALUES (5, 12,              CAST(\"512.6\" AS Decimal(22,9)));\n        UPSERT INTO table (`id`, `number`, `string`             ) VALUES (7, 15, \"pen\"          );\n        " } operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2026-01-08 02:57:26,854 - DEBUG - ydb.connection.2361227  - _log_response: RpcState(ExecuteDataQuery, 923b024c-bf51-4ad1-881a-d0ae5a1f80e5, ghrun-paw7opzmb4.auto.internal:32284): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.ExecuteQueryResult] { tx_meta { } } } } }
2026-01-08 02:57:26,855 - DEBUG - ya.test.2361227  - get_binary: Binary was found by /home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydb/ydb
2026-01-08 02:57:26,855 - DEBUG - ya.test.2361227  - _get_command_output_file: Command out will be placed to ydb.out
2026-01-08 02:57:26,855 - DEBUG - ya.test.2361227  - _get_command_output_file: Command err will be placed to ydb.err
2026-01-08 02:57:26,856 - DEBUG - ya.test.2361227  - execute: Executing '['/home/runner/.ya/build/build_root/pp6n/00348d/ydb/apps/ydb/ydb', '--verbose', '--endpoint', 'grpc://localhost:22822', '--database', '/Root', 'admin', 'cluster', 'dump', '--output', '/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir']' in 'None' (waiting)
2026-01-08 02:57:26,856 - DEBUG - ya.test.2361227  - execute: Command pid: 2436652
2026-01-08 02:57:27,110 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) rc: 0
2026-01-08 02:57:27,110 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) elapsed time (sec): 0.2532236576080322
2026-01-08 02:57:27,110 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) idrss: 0
2026-01-08 02:57:27,110 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) inblock: 0
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) isrss: 0
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) ixrss: 0
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) majflt: 1
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) maxrss: 165476
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) minflt: 3751
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) msgrcv: 0
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) msgsnd: 0
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) nivcsw: 1
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) nsignals: 0
2026-01-08 02:57:27,111 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) nswap: 0
2026-01-08 02:57:27,112 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) nvcsw: 357
2026-01-08 02:57:27,112 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) oublock: 72
2026-01-08 02:57:27,112 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) stime: 0.025259999999999998
2026-01-08 02:57:27,112 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) utime: 0.048144
2026-01-08 02:57:27,112 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) wtime: 0.254
2026-01-08 02:57:27,112 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) output:

2026-01-08 02:57:27,112 - DEBUG - ya.test.2361227  - _save_outputs: Command (pid 2436652) errors:
Using auth method "token" from YDB_TOKEN environment variable
2026-01-08T02:57:26.947657Z :INFO: Backup cluster to "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir"
2026-01-08T02:57:26.953448Z :INFO: Backup cluster root "/Root" to /home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir
2026-01-08T02:57:26.996755Z :DEBUG: Write users into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/create_user.sql"
2026-01-08T02:57:27.013123Z :DEBUG: Write groups into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/create_group.sql"
2026-01-08T02:57:27.027124Z :DEBUG: Write group members into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/alter_group.sql"
2026-01-08T02:57:27.029058Z :DEBUG: Write ACL into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/permissions.pb"
2026-01-08T02:57:27.031862Z :INFO: Backup database "/Root/db1" to "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/Root/db1"
2026-01-08T02:57:27.037118Z :DEBUG: Write database description into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/Root/db1/database.pb"
2026-01-08T02:57:27.068151Z :DEBUG: Write users into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/Root/db1/create_user.sql"
2026-01-08T02:57:27.082357Z :DEBUG: Write groups into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/Root/db1/create_group.sql"
2026-01-08T02:57:27.097950Z :DEBUG: Write group members into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/Root/db1/alter_group.sql"
2026-01-08T02:57:27.099774Z :DEBUG: Write ACL into "/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir/Root/db1/permissions.pb"
2026-01-08T02:57:27.100479Z :INFO: Backup cluster is completed successfully

2026-01-08 02:57:27,112 - DEBUG - __tests__.test_ydb_backup.2361227  - fs_recursive_list: prefix# /home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir path# 
2026-01-08 02:57:27,113 - DEBUG - __tests__.test_ydb_backup.2361227  - fs_recursive_list: prefix# /home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir path# Root
2026-01-08 02:57:27,113 - DEBUG - __tests__.test_ydb_backup.2361227  - fs_recursive_list: prefix# /home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/TestClusterBackup/backup_files_dir path# Root/db1
2026-01-08 02:57:27,113 - DEBUG - __tests__.test_ydb_backup.2361227  - create_backup: std_out:

2026-01-08 02:57:27,113 - DEBUG - __tests__.test_ydb_backup.2361227  - create_backup: fs_recursive_list(backup_files_dir)# ['permissions.pb', 'create_user.sql', 'alter_group.sql', 'create_group.sql', 'Root/db1/permissions.pb', 'Root/db1/create_user.sql', 'Root/db1/database.pb', 'Root/db1/alter_group.sql', 'Root/db1/create_group.sql']
2026-01-08 02:57:27,113 - DEBUG - __tests__.test_ydb_backup.2361227  - create_backup: expected_files# ['permissions.pb', 'create_user.sql', 'create_group.sql', 'alter_group.sql', 'Root/db1/database.pb', 'Root/db1/permissions.pb', 'Root/db1/create_user.sql', 'Root/db1/create_group.sql', 'Root/db1/alter_group.sql']
2026-01-08 02:57:27,115 - INFO - ya.test.2361227  - pytest_runtest_teardown: Test teardown
2026-01-08 02:57:28,115 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: hostname = 'ghrun-paw7opzmb4'
2026-01-08 02:57:28,116 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: rlimit_core = '(0, 0)'
2026-01-08 02:57:28,116 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: core_pattern = '|/usr/share/apport/apport -p%p -s%s -c%c -d%d -P%P -u%u -g%g -F%F -- %E'
2026-01-08 02:57:28,116 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: core_uses_pid = '1'
2026-01-08 02:57:28,117 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: Core dump dir (/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_1) permission mask: 0o40755 (expected: 0o41777 (0o40000-dir, 0o1000-sticky bit))
2026-01-08 02:57:28,117 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: Search for core dump files match pattern 'core.2362904' in '/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_1'
2026-01-08 02:57:28,117 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: Matched core dump files (0/3): [] (mismatched samples: stderr, stdout, logfile_kx8tsrsv.log)
2026-01-08 02:57:28,117 - WARNING - library.python.cores.2361227  - recover_core_dump_file: Core dump dir doesn't exist: /coredumps
2026-01-08 02:57:28,117 - WARNING - library.python.cores.2361227  - recover_core_dump_file: Core dump dir doesn't exist: /var/tmp/cores
2026-01-08 02:57:28,117 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - stop: Stopped node localhost:2746/1
2026-01-08 02:57:40,118 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - stop: Stopped node localhost:32284/2
2026-01-08 02:57:41,119 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: hostname = 'ghrun-paw7opzmb4'
2026-01-08 02:57:41,120 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: rlimit_core = '(0, 0)'
2026-01-08 02:57:41,120 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: core_pattern = '|/usr/share/apport/apport -p%p -s%s -c%c -d%d -P%P -u%u -g%g -F%F -- %E'
2026-01-08 02:57:41,120 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: core_uses_pid = '1'
2026-01-08 02:57:41,120 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: Core dump dir (/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_3) permission mask: 0o40755 (expected: 0o41777 (0o40000-dir, 0o1000-sticky bit))
2026-01-08 02:57:41,121 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: Search for core dump files match pattern 'core.2363391' in '/home/runner/.ya/build/build_root/pp6n/00348d/ydb/tests/functional/ydb_cli/test-results/py3test/testing_out_stuff/test_ydb_backup/chunk6/testing_out_stuff/test_ydb_backup.py.TestClusterBackup.test_cluster_backup/cluster/slot_3'
2026-01-08 02:57:41,121 - DEBUG - library.python.cores.2361227  - recover_core_dump_file: Matched core dump files (0/3): [] (mismatched samples: stderr, stdout, logfile_s16w_tsy.log)
2026-01-08 02:57:41,121 - WARNING - library.python.cores.2361227  - recover_core_dump_file: Core dump dir doesn't exist: /coredumps
2026-01-08 02:57:41,121 - WARNING - library.python.cores.2361227  - recover_core_dump_file: Core dump dir doesn't exist: /var/tmp/cores
2026-01-08 02:57:41,121 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - stop: Stopped node localhost:20807/3
2026-01-08 02:57:53,123 - INFO - ydb.tests.library.harness.kikimr_runner.2361227  - stop: Stopped node localhost:22822/1
2026-01-08 02:57:53,124 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/10976
2026-01-08 02:57:53,124 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/63658
2026-01-08 02:57:53,124 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/7565
2026-01-08 02:57:53,124 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/8982
2026-01-08 02:57:53,124 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/20807
2026-01-08 02:57:53,125 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/20672
2026-01-08 02:57:53,125 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/26336
2026-01-08 02:57:53,125 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/24183
2026-01-08 02:57:53,125 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/61838
2026-01-08 02:57:53,125 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/32284
2026-01-08 02:57:53,126 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/5218
2026-01-08 02:57:53,126 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/13266
2026-01-08 02:57:53,126 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/15822
2026-01-08 02:57:53,126 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/23288
2026-01-08 02:57:53,126 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/2746
2026-01-08 02:57:53,126 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/28537
2026-01-08 02:57:53,126 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/13609
2026-01-08 02:57:53,127 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/25464
2026-01-08 02:57:53,127 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/22822
2026-01-08 02:57:53,127 - DEBUG - library.python.filelock.2361227  - release: Ensuring FileLock released: /home/runner/.ya/build/port_sync_dir/17567
