2025-10-15T15:44:15.562516Z node 4 :METADATA_PROVIDER WARN: log.cpp:841: fline=table_exists.cpp:54;actor=TTableExistsActor;event=undelivered;self_id=[4:7561474847179471159:2263];send_to=[0:7307199536658146131:7762515];
2025-10-15T15:44:15.562810Z node 4 :METADATA_PROVIDER ERROR: log.cpp:841: fline=accessor_snapshot_base.cpp:71;action=cannot detect path existence;path=//Root/.metadata/initialization/migrations;error=scheme_cache_undelivered_message;
2025-10-15T15:44:15.588919Z node 4 :KQP_PROXY WARN: kqp_finalize_script_service.cpp:123: [ScriptExecutions] [TKqpFinalizeScriptService] Failed to check script execution tables existence, got undelivered to scheme cache: ActorUnknown
test_client.cpp: SetPath # /home/runner/.ya/build/build_root/w2kl/002eea/r3tmp/tmpd7xKB4/pdisk_1.dat
2025-10-15T15:44:15.659197Z node 4 :KQP_PROXY WARN: kqp_finalize_script_service.cpp:135: [ScriptExecutions] [TKqpFinalizeScriptService] Failed to check script execution tables existence, scheme status: LookupError, path: Root/.metadata/script_executions
2025-10-15T15:44:15.768011Z node 4 :IMPORT WARN: schemeshard_import.cpp:307: Table profiles were not loaded
2025-10-15T15:44:15.781054Z node 4 :HIVE WARN: node_info.cpp:25: HIVE#72057594037968897 Node(4, (0,0,0,0)) VolatileState: Unknown -> Disconnected
2025-10-15T15:44:15.781153Z node 4 :HIVE WARN: node_info.cpp:25: HIVE#72057594037968897 Node(4, (0,0,0,0)) VolatileState: Disconnected -> Connecting
2025-10-15T15:44:15.788537Z node 4 :HIVE WARN: node_info.cpp:25: HIVE#72057594037968897 Node(4, (0,0,0,0)) VolatileState: Connecting -> Connected
TServer::EnableGrpc on GrpcPort 5977, node 4
2025-10-15T15:44:15.922232Z node 4 :KQP_PROXY WARN: kqp_finalize_script_service.cpp:135: [ScriptExecutions] [TKqpFinalizeScriptService] Failed to check script execution tables existence, scheme status: PathErrorUnknown, path: Root/.metadata/script_executions
2025-10-15T15:44:15.952495Z node 4 :NET_CLASSIFIER WARN: net_classifier.cpp:190: distributable config is empty, broken or outdated, will use file: (empty maybe)
2025-10-15T15:44:15.952524Z node 4 :NET_CLASSIFIER WARN: net_classifier.cpp:196: will try to initialize from file: (empty maybe)
2025-10-15T15:44:15.952532Z node 4 :NET_CLASSIFIER WARN: net_classifier.cpp:204: failed to initialize from file: (empty maybe)
2025-10-15T15:44:15.952689Z node 4 :NET_CLASSIFIER ERROR: net_classifier.cpp:228: got bad distributable configuration
TClient is connected to server localhost:3827
WaitRootIsUp 'Root'...
TClient::Ls request: Root
TClient::Ls response: Status: 1
StatusCode: SUCCESS
SchemeStatus: 0
PathDescription {
  Self {
    Name: "Root"
    PathId: 1
    SchemeshardId: 72057594046644480
    PathType: EPathTypeDir
    CreateFinished: true
    CreateTxId: 1
    CreateStep: 0
    ParentPathId: 1
    PathState: EPathStateNoChanges
    Owner: "root@builtin"
    ACL: ""
    EffectiveACL: ""
    PathVersion: 2
    PathSubType: EPathSubTypeEmpty
    Version {
      GeneralVersion: 2
      ACLVersion: 0
      EffectiveACLVersion: 0
      UserAttrsVersion: 1
      ChildrenVersion: 1
      SubDomainVersion: 0
      SecurityStateVersion: 0
    }
    ChildrenExist: false
  }
  Children {
    Name: ".sys"
    PathId: 18446744073709551615
    SchemeshardId: 72057594046644480
    PathType: EPathTypeDir
    CreateFinished: true
    CreateTxId: 0
    CreateStep: 0
    ParentPathId: 18446744073709551615
  }
  DomainDescription {
    SchemeShardId_Depricated: 72057594046644480
    PathId_Depricated: 1
    ProcessingParams {
      Version: 0
      Pl...
(TRUNCATED)
WaitRootIsUp 'Root' success.
2025-10-15T15:44:16.202687Z node 4 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpAlterSubDomain, opId: 281474976715657:0, at schemeshard:  72057594046644480, first GetDB called at:  (GetDB first called at /home/runner/actions_runner/_work/ydb/ydb/ydb/core/tx/schemeshard/schemeshard__operation_alter_subdomain.cpp:311)
waiting...
2025-10-15T15:44:16.562273Z node 4 :TX_CONVEYOR ERROR: log.cpp:841: fline=service.h:53;problem=unexpected event for task executor;ev_type=NActors::TEvents::TEvWakeup;
2025-10-15T15:44:18.471791Z node 4 :KQP_WORKLOAD_SERVICE WARN: scheme_actors.cpp:225: [WorkloadService] [TPoolFetcherActor] ActorId: [4:7561474860064373923:2333], DatabaseId: /Root, PoolId: default, Failed to fetch pool info, NOT_FOUND, issues: { <main>: Error: Resource pool default not found or you don't have access permissions }
2025-10-15T15:44:18.471816Z node 4 :KQP_WORKLOAD_SERVICE WARN: scheme_actors.cpp:225: [WorkloadService] [TPoolFetcherActor] ActorId: [4:7561474860064373915:2330], DatabaseId: /Root, PoolId: default, Failed to fetch pool info, NOT_FOUND, issues: { <main>: Error: Resource pool default not found or you don't have access permissions }
2025-10-15T15:44:18.471898Z node 4 :KQP_WORKLOAD_SERVICE WARN: kqp_workload_service.cpp:263: [WorkloadService] [Service] Failed to fetch pool default, DatabaseId: /Root, status: NOT_FOUND, issues: { <main>: Error: Resource pool default not found or you don't have access permissions }
2025-10-15T15:44:18.472047Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:314: actor# [4:7561474847179471171:2120] Handle TEvProposeTransaction
2025-10-15T15:44:18.472066Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:237: actor# [4:7561474847179471171:2120] TxId# 281474976715658 ProcessProposeTransaction
2025-10-15T15:44:18.472099Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:256: actor# [4:7561474847179471171:2120] Cookie# 0 userReqId# "" txid# 281474976715658 SEND to# [4:7561474860064373931:2634]
2025-10-15T15:44:18.473357Z node 4 :KQP_WORKLOAD_SERVICE WARN: scheme_actors.cpp:225: [WorkloadService] [TPoolFetcherActor] ActorId: [4:7561474860064373930:2335], DatabaseId: /Root, PoolId: default, Failed to fetch pool info, NOT_FOUND, issues: { <main>: Error: Resource pool default not found or you don't have access permissions }
2025-10-15T15:44:18.473432Z node 4 :KQP_WORKLOAD_SERVICE WARN: kqp_workload_service.cpp:263: [WorkloadService] [Service] Failed to fetch pool default, DatabaseId: /Root, status: NOT_FOUND, issues: { <main>: Error: Resource pool default not found or you don't have access permissions }
2025-10-15T15:44:18.474898Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1673: Actor# [4:7561474860064373931:2634] txid# 281474976715658 Bootstrap EvSchemeRequest record: Transaction { ModifyScheme { WorkingDir: "/Root/.metadata/workload_manager/pools" OperationType: ESchemeOpCreateResourcePool ModifyACL { Name: "default" DiffACL: "\n!\010\000\022\035\010\001\020\201\004\032\024all-users@well-known \003\n\031\010\000\022\025\010\001\020\201\004\032\014root@builtin \003" NewOwner: "metadata@system" } Internal: true CreateResourcePool { Name: "default" Properties { Properties { key: "concurrent_query_limit" value: "-1" } Properties { key: "database_load_cpu_threshold" value: "-1" } Properties { key: "query_cancel_after_seconds" value: "0" } Properties { key: "query_cpu_limit_percent_per_node" value: "-1" } Properties { key: "query_memory_limit_percent_per_node" value: "-1" } Properties { key: "queue_size" value: "-1" } Properties { key: "resource_weight" value: "-1" } Properties { key: "total_cpu_limit_percent_per_node" value: "-1" } } } } } UserToken: "\n\017metadata@system\022\000" DatabaseName: "/Root" 
2025-10-15T15:44:18.474947Z node 4 :TX_PROXY DEBUG: schemereq.cpp:613: Actor# [4:7561474860064373931:2634] txid# 281474976715658 Bootstrap, UserSID: metadata@system CheckAdministrator: 0 CheckDatabaseAdministrator: 0
2025-10-15T15:44:18.474963Z node 4 :TX_PROXY DEBUG: schemereq.cpp:622: Actor# [4:7561474860064373931:2634] txid# 281474976715658 Bootstrap, UserSID: metadata@system IsClusterAdministrator: 1
2025-10-15T15:44:18.476339Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1738: Actor# [4:7561474860064373931:2634] txid# 281474976715658 HANDLE EvNavigateKeySetResult TFlatSchemeReq marker# P6
2025-10-15T15:44:18.476657Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1728: Actor# [4:7561474860064373931:2634] txid# 281474976715658 TEvNavigateKeySet requested from SchemeCache
2025-10-15T15:44:18.476942Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1561: Actor# [4:7561474860064373931:2634] txid# 281474976715658 HANDLE EvNavigateKeySetResult TFlatSchemeReq marker# P5 ErrorCount# 0
2025-10-15T15:44:18.477079Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1608: Actor# [4:7561474860064373931:2634] HANDLE EvNavigateKeySetResult, txid# 281474976715658 shardToRequest# 72057594046644480 DomainKey# [OwnerId: 72057594046644480, LocalPathId: 1] DomainInfo.Params# Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 RedirectRequired# true
2025-10-15T15:44:18.477137Z node 4 :TX_PROXY DEBUG: schemereq.cpp:103: Actor# [4:7561474860064373931:2634] txid# 281474976715658 SEND to# 72057594046644480 shardToRequest {TEvModifySchemeTransaction txid# 281474976715658 TabletId# 72057594046644480}
2025-10-15T15:44:18.477266Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1463: Actor# [4:7561474860064373931:2634] txid# 281474976715658 HANDLE EvClientConnected
2025-10-15T15:44:18.478376Z node 4 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpCreateResourcePool, opId: 281474976715658:3, at schemeshard:  72057594046644480, first GetDB called at:  (GetDB first called at /home/runner/actions_runner/_work/ydb/ydb/ydb/core/tx/schemeshard/schemeshard__operation_create_resource_pool.cpp:179)
2025-10-15T15:44:18.482189Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1485: Actor# [4:7561474860064373931:2634] txid# 281474976715658 Status StatusAccepted HANDLE {TEvModifySchemeTransactionResult Status# StatusAccepted txid# 281474976715658}
2025-10-15T15:44:18.482232Z node 4 :TX_PROXY DEBUG: schemereq.cpp:593: Actor# [4:7561474860064373931:2634] txid# 281474976715658 SEND to# [4:7561474860064373929:2334] Source {TEvProposeTransactionStatus txid# 281474976715658 Status# 53}
2025-10-15T15:44:18.513572Z node 4 :KQP_WORKLOAD_SERVICE WARN: helpers.h:73: [WorkloadService] [TPoolCreatorActor] ActorId: [4:7561474860064373929:2334], DatabaseId: /Root, PoolId: default, Scheduled retry for error: { <main>: Error: Transaction 281474976715658 completed, doublechecking }
2025-10-15T15:44:18.593470Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:314: actor# [4:7561474847179471171:2120] Handle TEvProposeTransaction
2025-10-15T15:44:18.593495Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:237: actor# [4:7561474847179471171:2120] TxId# 281474976715659 ProcessProposeTransaction
2025-10-15T15:44:18.593531Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:256: actor# [4:7561474847179471171:2120] Cookie# 0 userReqId# "" txid# 281474976715659 SEND to# [4:7561474860064374009:2691]
2025-10-15T15:44:18.595833Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1673: Actor# [4:7561474860064374009:2691] txid# 281474976715659 Bootstrap EvSchemeRequest record: Transaction { ModifyScheme { WorkingDir: "/Root/.metadata/workload_manager/pools" OperationType: ESchemeOpCreateResourcePool ModifyACL { Name: "default" DiffACL: "\n!\010\000\022\035\010\001\020\201\004\032\024all-users@well-known \003\n\031\010\000\022\025\010\001\020\201\004\032\014root@builtin \003" NewOwner: "metadata@system" } Internal: true CreateResourcePool { Name: "default" Properties { Properties { key: "concurrent_query_limit" value: "-1" } Properties { key: "database_load_cpu_threshold" value: "-1" } Properties { key: "query_cancel_after_seconds" value: "0" } Properties { key: "query_cpu_limit_percent_per_node" value: "-1" } Properties { key: "query_memory_limit_percent_per_node" value: "-1" } Properties { key: "queue_size" value: "-1" } Properties { key: "resource_weight" value: "-1" } Properties { key: "total_cpu_limit_percent_per_node" value: "-1" } } } } } UserToken: "\n\017metadata@system\022\000" DatabaseName: "/Root" 
2025-10-15T15:44:18.595864Z node 4 :TX_PROXY DEBUG: schemereq.cpp:613: Actor# [4:7561474860064374009:2691] txid# 281474976715659 Bootstrap, UserSID: metadata@system CheckAdministrator: 0 CheckDatabaseAdministrator: 0
2025-10-15T15:44:18.595874Z node 4 :TX_PROXY DEBUG: schemereq.cpp:622: Actor# [4:7561474860064374009:2691] txid# 281474976715659 Bootstrap, UserSID: metadata@system IsClusterAdministrator: 1
2025-10-15T15:44:18.596569Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1738: Actor# [4:7561474860064374009:2691] txid# 281474976715659 HANDLE EvNavigateKeySetResult TFlatSchemeReq marker# P6
2025-10-15T15:44:18.596637Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1728: Actor# [4:7561474860064374009:2691] txid# 281474976715659 TEvNavigateKeySet requested from SchemeCache
2025-10-15T15:44:18.596840Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1561: Actor# [4:7561474860064374009:2691] txid# 281474976715659 HANDLE EvNavigateKeySetResult TFlatSchemeReq marker# P5 ErrorCount# 0
2025-10-15T15:44:18.596953Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1608: Actor# [4:7561474860064374009:2691] HANDLE EvNavigateKeySetResult, txid# 281474976715659 shardToRequest# 72057594046644480 DomainKey# [OwnerId: 72057594046644480, LocalPathId: 1] DomainInfo.Params# Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 RedirectRequired# true
2025-10-15T15:44:18.596992Z node 4 :TX_PROXY DEBUG: schemereq.cpp:103: Actor# [4:7561474860064374009:2691] txid# 281474976715659 SEND to# 72057594046644480 shardToRequest {TEvModifySchemeTransaction txid# 281474976715659 TabletId# 72057594046644480}
2025-10-15T15:44:18.597132Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1463: Actor# [4:7561474860064374009:2691] txid# 281474976715659 HANDLE EvClientConnected
2025-10-15T15:44:18.606301Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1485: Actor# [4:7561474860064374009:2691] txid# 281474976715659 Status StatusAlreadyExists HANDLE {TEvModifySchemeTransactionResult Status# StatusAlreadyExists txid# 281474976715659 Reason# Check failed: path: '/Root/.metadata/workload_manager/pools/default', error: path exist, request accepts it (id: [OwnerId: 72057594046644480, LocalPathId: 5], type: EPathTypeResourcePool, state: EPathStateNoChanges)}
2025-10-15T15:44:18.606426Z node 4 :TX_PROXY ERROR: schemereq.cpp:590: Actor# [4:7561474860064374009:2691] txid# 281474976715659, issues: { message: "Check failed: path: \'/Root/.metadata/workload_manager/pools/default\', error: path exist, request accepts it (id: [OwnerId: 72057594046644480, LocalPathId: 5], type: EPathTypeResourcePool, state: EPathStateNoChanges)" severity: 1 }
2025-10-15T15:44:18.606453Z node 4 :TX_PROXY DEBUG: schemereq.cpp:593: Actor# [4:7561474860064374009:2691] txid# 281474976715659 SEND to# [4:7561474860064373929:2334] Source {TEvProposeTransactionStatus txid# 281474976715659 Status# 48}
2025-10-15T15:44:18.685849Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:314: actor# [4:7561474847179471171:2120] Handle TEvProposeTransaction
2025-10-15T15:44:18.685888Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:237: actor# [4:7561474847179471171:2120] TxId# 281474976715660 ProcessProposeTransaction
2025-10-15T15:44:18.685957Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:256: actor# [4:7561474847179471171:2120] Cookie# 0 userReqId# "" txid# 281474976715660 SEND to# [4:7561474860064374045:2704]
2025-10-15T15:44:18.688751Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1673: Actor# [4:7561474860064374045:2704] txid# 281474976715660 Bootstrap EvSchemeRequest record: Transaction { ModifyScheme { WorkingDir: "/Root" OperationType: ESchemeOpCreateTable CreateTable { Name: "Int16Table" Columns { Name: "Key" Type: "Int16" NotNull: false } Columns { Name: "Value" Type: "Int32" NotNull: false } KeyColumnNames: "Key" PartitionConfig { } Temporary: false } FailedOnAlreadyExists: true } } UserToken: "" DatabaseName: "/Root" RequestType: "" PeerName: "ipv6:[::1]:42272" 
2025-10-15T15:44:18.688786Z node 4 :TX_PROXY DEBUG: schemereq.cpp:613: Actor# [4:7561474860064374045:2704] txid# 281474976715660 Bootstrap, UserSID: <empty> CheckAdministrator: 0 CheckDatabaseAdministrator: 0
2025-10-15T15:44:18.697830Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1738: Actor# [4:7561474860064374045:2704] txid# 281474976715660 HANDLE EvNavigateKeySetResult TFlatSchemeReq marker# P6
2025-10-15T15:44:18.697932Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1728: Actor# [4:7561474860064374045:2704] txid# 281474976715660 TEvNavigateKeySet requested from SchemeCache
2025-10-15T15:44:18.698235Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1561: Actor# [4:7561474860064374045:2704] txid# 281474976715660 HANDLE EvNavigateKeySetResult TFlatSchemeReq marker# P5 ErrorCount# 0
2025-10-15T15:44:18.698366Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1608: Actor# [4:7561474860064374045:2704] HANDLE EvNavigateKeySetResult, txid# 281474976715660 shardToRequest# 72057594046644480 DomainKey# [OwnerId: 72057594046644480, LocalPathId: 1] DomainInfo.Params# Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 RedirectRequired# true
2025-10-15T15:44:18.698406Z node 4 :TX_PROXY DEBUG: schemereq.cpp:103: Actor# [4:7561474860064374045:2704] txid# 281474976715660 SEND to# 72057594046644480 shardToRequest {TEvModifySchemeTransaction txid# 281474976715660 TabletId# 72057594046644480}
2025-10-15T15:44:18.698551Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1463: Actor# [4:7561474860064374045:2704] txid# 281474976715660 HANDLE EvClientConnected
2025-10-15T15:44:18.700024Z node 4 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpCreateTable, opId: 281474976715660:0, at schemeshard:  72057594046644480, first GetDB called at:  (GetDB first called at /home/runner/actions_runner/_work/ydb/ydb/ydb/core/tx/schemeshard/schemeshard__operation_create_table.cpp:684)
2025-10-15T15:44:18.706998Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1485: Actor# [4:7561474860064374045:2704] txid# 281474976715660 Status StatusAccepted HANDLE {TEvModifySchemeTransactionResult Status# StatusAccepted txid# 281474976715660}
2025-10-15T15:44:18.707055Z node 4 :TX_PROXY DEBUG: schemereq.cpp:593: Actor# [4:7561474860064374045:2704] txid# 281474976715660 SEND to# [4:7561474860064374044:2327] Source {TEvProposeTransactionStatus txid# 281474976715660 Status# 53}
2025-10-15T15:44:18.853603Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:352: actor# [4:7561474847179471171:2120] Handle TEvExecuteKqpTransaction
2025-10-15T15:44:18.853632Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:341: actor# [4:7561474847179471171:2120] TxId# 281474976715661 ProcessProposeKqpTransaction
2025-10-15T15:44:18.961529Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:352: actor# [4:7561474847179471171:2120] Handle TEvExecuteKqpTransaction
2025-10-15T15:44:18.961560Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:341: actor# [4:7561474847179471171:2120] TxId# 281474976715662 ProcessProposeKqpTransaction
2025-10-15T15:44:18.975234Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:402: actor# [4:7561474847179471171:2120] Handle TEvNavigate  describe path /Root
2025-10-15T15:44:18.975293Z node 4 :TX_PROXY DEBUG: describe.cpp:270: Actor# [4:7561474860064374247:2839] HANDLE EvNavigateScheme /Root
2025-10-15T15:44:18.975583Z node 4 :TX_PROXY DEBUG: describe.cpp:354: Actor# [4:7561474860064374247:2839] HANDLE EvNavigateKeySetResult TDescribeReq marker# P5 ErrorCount# 0
2025-10-15T15:44:18.975700Z node 4 :TX_PROXY DEBUG: describe.cpp:433: Actor# [4:7561474860064374247:2839] SEND to# 72057594046644480 shardToRequest NKikimrSchemeOp.TDescribePath Path: "/Root" Options { ShowPrivateTable: false }
2025-10-15T15:44:18.976411Z node 4 :TX_PROXY DEBUG: describe.cpp:446: Actor# [4:7561474860064374247:2839] Handle TEvDescribeSchemeResult Forward to# [4:7561474860064374245:2361] Cookie: 0 TEvDescribeSchemeResult: NKikimrScheme.TEvDescribeSchemeResult PreSerializedData size# 141 Record# Status: StatusSuccess Path: "/Root" PathDescription { Self { Name: "Root" PathId: 1 SchemeshardId: 72057594046644480 PathType: EPathTypeDir CreateFinished: true CreateTxId: 1 CreateStep: 1760543056272 ParentPathId: 1 PathState: EPathStateNoChanges Owner: "root@builtin" ACL: "" EffectiveACL: "" PathVersion: 8 PathSubType: EPathSubTypeEmpty Version { GeneralVersion: 8 ACLVersion: 0 EffectiveACLVersion: 0 UserAttrsVersion: 1 ChildrenVersion: 6 SubDomainVersion: 1 SecurityStateVersion: 0 } ChildrenExist: true } DomainDescription { SchemeShardId_Depricated: 72057594046644480 PathId_Depricated: 1 ProcessingParams { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } DomainKey { SchemeShard: 72057594046644480 PathId: 1 } StoragePools { Name: "/Root:test" Kind: "test" } StoragePools { Name: "hdd" Kind: "hdd" } StoragePools { Name: "hdd1" Kind: "hdd1" } StoragePools { Name: "hdd2" Kind: "hdd2" } StoragePools { Name: "ssd" Kind: "ssd" } PathsInside: 5 PathsLimit: 10000 ShardsInside: 1 ShardsLimit: 200000 ResourcesDomainKey { SchemeShard: 72057594046644480 PathId: 1 } DiskSpaceUsage { Tables { TotalSize: 0 DataSize: 0 IndexSize: 0 } Topics { ReserveSize: 0 AccountSize: 0 DataSize: 0 UsedReserveSize: 0 } } PQPartitionsInside: 0 PQPartitionsLimit: 1000000 SecurityState { Audience: "/Root" } SchemeLimits { MaxDepth: 32 MaxPaths: 10000 MaxChildrenInDir: 100000 MaxAclBytesSize: 10240 MaxTableColumns: 200 MaxTableColumnNameLength: 255 MaxTableKeyColumns: 30 MaxTableIndices: 20 MaxShards: 200000 MaxShardsInPath: 35000 MaxConsistentCopyTargets: 10000 MaxPathElementLength: 255 ExtraPathSymbolsAllowed: "!\"#$%&\'()*+,-.:;<=>?@[\\]^_`{|}~" MaxPQPartitions: 1000000 MaxTableCdcStreams: 5 MaxExports: 10 MaxImports: 10 MaxColumnTableColumns: 10000 } } } PathId: 1 PathOwnerId: 72057594046644480
2025-10-15T15:44:18.990890Z node 4 :TX_PROXY DEBUG: rpc_export.cpp:210: [CreateExport] [4:7561474860064374249:2362] [0] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } },{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } },{ Path: Root/Int16Table TableId: [72057594046644480:6:1] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindTable DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:18.990931Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:37: [CreateExport] [4:7561474860064374249:2362] [0] Allocate txId
2025-10-15T15:44:18.991024Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:374: actor# [4:7561474847179471171:2120] Handle TEvAllocateTxId
2025-10-15T15:44:18.991088Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:44: [CreateExport] [4:7561474860064374249:2362] [281474976715663] TEvTxUserProxy::TEvAllocateTxIdResult
2025-10-15T15:44:18.991101Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [CreateExport] [4:7561474860064374249:2362] [281474976715663] Resolve database: name# /Root
2025-10-15T15:44:18.991350Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [CreateExport] [4:7561474860064374249:2362] [281474976715663] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:18.991377Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [CreateExport] [4:7561474860064374249:2362] [281474976715663] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:18.991813Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:58: TExport::TTxCreate: DoExecute
2025-10-15T15:44:18.992086Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:198: TExport::TTxCreate: Reply: status# SUCCESS, error# 
2025-10-15T15:44:18.993867Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:182: TExport::TTxCreate: DoComplete
2025-10-15T15:44:18.993973Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:18.993984Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:736: TExport::TTxProgress: Resume: id# 281474976715663
2025-10-15T15:44:18.994028Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:534: TExport::TTxProgress: Allocate txId: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: <Invalid> UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: CreateExportDir WaitTxId: 0 Issue: '' Items: 1 PendingItems: 1 PendingDropItems: 0 }
2025-10-15T15:44:18.994076Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:18.994141Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:18.994152Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:856: TExport::TTxProgress: OnAllocateResult: txId# 281474976710757, id# 281474976715663
2025-10-15T15:44:18.994196Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:333: TExport::TTxProgress: MkDir propose: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: <Invalid> UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: CreateExportDir WaitTxId: 0 Issue: '' Items: 1 PendingItems: 1 PendingDropItems: 0 }, txId# 281474976710757
2025-10-15T15:44:18.994259Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:18.995355Z node 4 :TX_PROXY DEBUG: rpc_export.cpp:371: [CreateExport] [4:7561474860064374249:2362] [281474976715663] Handle TEvExport::TEvCreateExportResponse: record# Entry { Id: 281474976715663 Status: SUCCESS Progress: PROGRESS_PREPARING ExportToS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_path: "/Root/Int16Table" destination_prefix: "/Int16Table" } source_path: "/Root" } StartTime { seconds: 1760543058 } }
2025-10-15T15:44:18.996921Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:18.996940Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:917: TExport::TTxProgress: OnModifyResult: txId# 281474976710757, status# StatusAccepted
2025-10-15T15:44:18.997041Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:1099: TExport::TTxProgress: Wait for completion: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: CreateExportDir WaitTxId: 281474976710757 Issue: '' Items: 1 PendingItems: 1 PendingDropItems: 0 }, itemIdx# 4294967295, txId# 281474976710757
2025-10-15T15:44:18.999396Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.006108Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.006134Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1236: TExport::TTxProgress: OnNotifyResult: txId# 281474976710757
2025-10-15T15:44:19.006146Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1267: TExport::TTxProgress: OnNotifyResult: txId# 281474976710757, id# 281474976715663, itemIdx# 4294967295
2025-10-15T15:44:19.006179Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:534: TExport::TTxProgress: Allocate txId: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: CopyTables WaitTxId: 0 Issue: '' Items: 1 PendingItems: 1 PendingDropItems: 0 }
2025-10-15T15:44:19.007368Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.007457Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.007468Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:856: TExport::TTxProgress: OnAllocateResult: txId# 281474976710758, id# 281474976715663
2025-10-15T15:44:19.007502Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:342: TExport::TTxProgress: CopyTables propose: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: CopyTables WaitTxId: 0 Issue: '' Items: 1 PendingItems: 1 PendingDropItems: 0 }, txId# 281474976710758
2025-10-15T15:44:19.007563Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.010412Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.010435Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:917: TExport::TTxProgress: OnModifyResult: txId# 281474976710758, status# StatusAccepted
2025-10-15T15:44:19.010494Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:1099: TExport::TTxProgress: Wait for completion: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: CopyTables WaitTxId: 281474976710758 Issue: '' Items: 1 PendingItems: 1 PendingDropItems: 0 }, itemIdx# 4294967295, txId# 281474976710758
2025-10-15T15:44:19.013917Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [GetExport] [4:7561474864359341596:2363] [0] Resolve database: name# /Root
2025-10-15T15:44:19.014440Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [GetExport] [4:7561474864359341596:2363] [0] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:19.014465Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [GetExport] [4:7561474864359341596:2363] [0] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:19.015586Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.017826Z node 4 :TX_PROXY DEBUG: rpc_get_operation.cpp:227: [GetExport] [4:7561474864359341596:2363] [0] Handle TEvExport::TEvGetExportResponse: record# Entry { Id: 281474976715663 Status: SUCCESS Progress: PROGRESS_PREPARING ExportToS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_path: "/Root/Int16Table" destination_prefix: "/Int16Table" } source_path: "/Root" } StartTime { seconds: 1760543058 } }
2025-10-15T15:44:19.082336Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.082361Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1236: TExport::TTxProgress: OnNotifyResult: txId# 281474976710758
2025-10-15T15:44:19.082374Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1267: TExport::TTxProgress: OnNotifyResult: txId# 281474976710758, id# 281474976715663, itemIdx# 4294967295
2025-10-15T15:44:19.082461Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:548: TExport::TTxProgress: Allocate txId: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: Transferring WaitTxId: 0 Issue: '' Items: 1 PendingItems: 1 PendingDropItems: 0 }, item# { Idx: 0 SourcePathName: '/Root/Int16Table' SourcePathId: [OwnerId: 72057594046644480, LocalPathId: 6] SourcePathType: EPathTypeTable State: Transferring SubState: AllocateTxId WaitTxId: 0 Issue: '' }
2025-10-15T15:44:19.083822Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.083885Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.083897Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:856: TExport::TTxProgress: OnAllocateResult: txId# 281474976710759, id# 281474976715663
2025-10-15T15:44:19.083940Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:358: TExport::TTxProgress: Backup propose: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: Transferring WaitTxId: 0 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 0 }, item# { Idx: 0 SourcePathName: '/Root/Int16Table' SourcePathId: [OwnerId: 72057594046644480, LocalPathId: 6] SourcePathType: EPathTypeTable State: Transferring SubState: Proposed WaitTxId: 0 Issue: '' }, txId# 281474976710759
2025-10-15T15:44:19.084971Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.085598Z node 4 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpBackup, opId: 281474976710759:0, at schemeshard:  72057594046644480, first GetDB called at:  (GetDB first called at /home/runner/actions_runner/_work/ydb/ydb/ydb/core/tx/schemeshard/schemeshard__operation_backup_restore_common.h:563)
2025-10-15T15:44:19.087569Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.087603Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:917: TExport::TTxProgress: OnModifyResult: txId# 281474976710759, status# StatusAccepted
2025-10-15T15:44:19.087667Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:1099: TExport::TTxProgress: Wait for completion: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: Transferring WaitTxId: 0 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 0 }, itemIdx# 0, txId# 281474976710759
2025-10-15T15:44:19.089398Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
REQUEST: PUT /test_bucket/Int16Table/metadata.json HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 1F434A15-8B8F-41D4-9633-7429EFD145EA
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=1427fda83097c6b8034e0b44d402ca98361f3c42550f833b340e23d35163e5f3
content-length: 112
content-md5: dvTuXjNIinCeZhfVXjUCOg==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: 3067ca343cf5bebd63b579eb867b6613aa603ad57de7d2259eff06406123707f
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/metadata.json /  / 112
REQUEST: PUT /test_bucket/Int16Table/metadata.json.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 244E20B6-4688-46B0-BC33-B1FD46CE2FFE
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=f2ef0c614c44a71c805b05ae8473507ab13b0b21ade223563cfe10bc1f6d1ccc
content-length: 78
content-md5: p1L/79JDFJ5LoPFKbFFDPQ==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: fae3d655e6e57c103e1ffe20d58b0812aeaa3d971375b19cd7c22e9b2310c753
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/metadata.json.sha256 /  / 78
REQUEST: PUT /test_bucket/Int16Table/permissions.pb HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: D01E28ED-E1E9-4584-A5D6-B482748609AB
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=78c863ad9c924984a342e148bd4f14a404d58f6d09d8d8f422291b69fdcde991
content-length: 43
content-md5: JIqMFsQjXF0c+sG0y+coog==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: b41fd8921ff3a7314d9c702dc0e71aace6af8443e0102add0432895c5e50a326
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/permissions.pb /  / 43
REQUEST: PUT /test_bucket/Int16Table/permissions.pb.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 79D914E4-7E4C-427F-BE33-F45EF7AA415F
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=33bbe2a0314ab475712ed72b90dbb6d8411f766e7e38e4c29f6c0d52cdbd2f56
content-length: 79
content-md5: pyxreRSjbWoiHCsxZEDssw==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: 8b9fdf7d565695d430e3821a5a3c9b1a9d7cb4b812ed7dd74dbfb46c004b30de
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/permissions.pb.sha256 /  / 79
REQUEST: PUT /test_bucket/Int16Table/scheme.pb HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 8087CD83-0481-4571-848B-FB6BE917E7B8
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=d780b332df0f6717c6e56ea0bc6397515b04b83fcdbcb859531c4878a5eee469
content-length: 357
content-md5: AqMobvhIlJ62PftfvV2YDg==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: a7f1d270147cbc41be017fcf208f3dd1f5644121cb4baee88c09683b76afb617
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/scheme.pb /  / 357
REQUEST: PUT /test_bucket/Int16Table/scheme.pb.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: D12E94BA-883F-4AAD-B70F-3F21E7663CA0
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=fef54fc9d1632cf41e99a5df7f85a3035c1b22939a0f2b5646939ee59d6622ae
content-length: 74
content-md5: xOSpqOEFwO4t2Tb/PWP71g==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: 622f75a72a543a7424582f8a1981eb4f5cf0b7b0c7288600ac935ab57b291f2c
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/scheme.pb.sha256 /  / 74
REQUEST: PUT /test_bucket/Int16Table/data_00.csv HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: A0E1DE91-64A6-411C-9C79-9C3B91C21F26
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=97508293d8c216efcf0e4d1584e4eb241c479275731d077ac9ecc5c42d3c6760
content-length: 4
content-md5: UCjUrvlcAitDx+4I59AEkg==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: 8d66c089414bb76bc2ee5c11465c93257821752b4e08be4f1d70737b9fa10f0c
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/data_00.csv /  / 4
REQUEST: PUT /test_bucket/Int16Table/data_00.csv.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 02544C77-C253-41B8-B8AC-EB24A11DA9A7
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-length;content-md5;content-type;host;x-amz-content-sha256;x-amz-date, Signature=fd9b76507e0baed032bb08008d991ac23cc803783a96d68c81095ecdeadcff9c
content-length: 76
content-md5: yA5kNd5mc6q1y5UtVMHXiA==
content-type: binary/octet-stream
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-content-sha256: 05fe8451a7c9c0f63236acb1d7af5ff7a531251bdc88ba0110586f3de8e1486a
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeWrite: /test_bucket/Int16Table/data_00.csv.sha256 /  / 76
2025-10-15T15:44:19.181379Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.181405Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1236: TExport::TTxProgress: OnNotifyResult: txId# 281474976710759
2025-10-15T15:44:19.181418Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1267: TExport::TTxProgress: OnNotifyResult: txId# 281474976710759, id# 281474976715663, itemIdx# 0
2025-10-15T15:44:19.181615Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:548: TExport::TTxProgress: Allocate txId: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: AutoDropping WaitTxId: 0 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 1 }, item# { Idx: 0 SourcePathName: '/Root/Int16Table' SourcePathId: [OwnerId: 72057594046644480, LocalPathId: 6] SourcePathType: EPathTypeTable State: Dropping SubState: AllocateTxId WaitTxId: 0 Issue: '' }
2025-10-15T15:44:19.183103Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.183187Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.183199Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:856: TExport::TTxProgress: OnAllocateResult: txId# 281474976710760, id# 281474976715663
2025-10-15T15:44:19.183252Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:517: TExport::TTxProgress: Drop propose: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: AutoDropping WaitTxId: 0 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 0 }, item# { Idx: 0 SourcePathName: '/Root/Int16Table' SourcePathId: [OwnerId: 72057594046644480, LocalPathId: 6] SourcePathType: EPathTypeTable State: Dropping SubState: AllocateTxId WaitTxId: 0 Issue: '' }, txId# 281474976710760
2025-10-15T15:44:19.183312Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.185657Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.185680Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:917: TExport::TTxProgress: OnModifyResult: txId# 281474976710760, status# StatusAccepted
2025-10-15T15:44:19.185742Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:1099: TExport::TTxProgress: Wait for completion: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: AutoDropping WaitTxId: 0 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 0 }, itemIdx# 0, txId# 281474976710760
2025-10-15T15:44:19.187695Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.220075Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.220100Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1236: TExport::TTxProgress: OnNotifyResult: txId# 281474976710760
2025-10-15T15:44:19.220112Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1267: TExport::TTxProgress: OnNotifyResult: txId# 281474976710760, id# 281474976715663, itemIdx# 0
2025-10-15T15:44:19.220185Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:534: TExport::TTxProgress: Allocate txId: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: AutoDropping WaitTxId: 0 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 0 }
2025-10-15T15:44:19.223689Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.223765Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.223776Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:856: TExport::TTxProgress: OnAllocateResult: txId# 281474976710761, id# 281474976715663
2025-10-15T15:44:19.223813Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:526: TExport::TTxProgress: Drop propose: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: AutoDropping WaitTxId: 0 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 0 }, txId# 281474976710761
2025-10-15T15:44:19.223876Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.224164Z node 4 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpRmDir, opId: 281474976710761:0, at schemeshard:  72057594046644480, first GetDB called at:  (GetDB first called at /home/runner/actions_runner/_work/ydb/ydb/ydb/core/tx/schemeshard/schemeshard__operation_rmdir.cpp:66)
2025-10-15T15:44:19.224708Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [GetExport] [4:7561474864359341869:2371] [0] Resolve database: name# /Root
2025-10-15T15:44:19.225654Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [GetExport] [4:7561474864359341869:2371] [0] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:19.225673Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [GetExport] [4:7561474864359341869:2371] [0] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:19.226582Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.226605Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:917: TExport::TTxProgress: OnModifyResult: txId# 281474976710761, status# StatusAccepted
2025-10-15T15:44:19.226679Z node 4 :EXPORT INFO: schemeshard_export__create.cpp:1099: TExport::TTxProgress: Wait for completion: info# { Id: 281474976715663 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] ExportPathId: [OwnerId: 72057594046644480, LocalPathId: 7] UserSID: '(empty maybe)' PeerName: 'ipv6:[::1]:42272' State: AutoDropping WaitTxId: 281474976710761 Issue: '' Items: 1 PendingItems: 0 PendingDropItems: 0 }, itemIdx# 4294967295, txId# 281474976710761
2025-10-15T15:44:19.231592Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.232038Z node 4 :TX_PROXY DEBUG: rpc_get_operation.cpp:227: [GetExport] [4:7561474864359341869:2371] [0] Handle TEvExport::TEvGetExportResponse: record# Entry { Id: 281474976715663 Status: SUCCESS Progress: PROGRESS_TRANSFER_DATA ExportToS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_path: "/Root/Int16Table" destination_prefix: "/Int16Table" } source_path: "/Root" } ItemsProgress { } StartTime { seconds: 1760543058 } }
2025-10-15T15:44:19.246058Z node 4 :HIVE WARN: hive_impl.cpp:516: HIVE#72057594037968897 Handle TEvLocal::TEvTabletStatus from node 4, TabletId: 72075186224037889 not found
2025-10-15T15:44:19.255559Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:306: TExport::TTxProgress: DoExecute
2025-10-15T15:44:19.255591Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1236: TExport::TTxProgress: OnNotifyResult: txId# 281474976710761
2025-10-15T15:44:19.255606Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:1267: TExport::TTxProgress: OnNotifyResult: txId# 281474976710761, id# 281474976715663, itemIdx# 4294967295
2025-10-15T15:44:19.258908Z node 4 :EXPORT DEBUG: schemeshard_export__create.cpp:326: TExport::TTxProgress: DoComplete
2025-10-15T15:44:19.640188Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [GetExport] [4:7561474864359341933:2375] [0] Resolve database: name# /Root
2025-10-15T15:44:19.643527Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [GetExport] [4:7561474864359341933:2375] [0] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:19.643566Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [GetExport] [4:7561474864359341933:2375] [0] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:19.650080Z node 4 :TX_PROXY DEBUG: rpc_get_operation.cpp:227: [GetExport] [4:7561474864359341933:2375] [0] Handle TEvExport::TEvGetExportResponse: record# Entry { Id: 281474976715663 Status: SUCCESS Progress: PROGRESS_DONE ExportToS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_path: "/Root/Int16Table" destination_prefix: "/Int16Table" } source_path: "/Root" } ItemsProgress { } StartTime { seconds: 1760543058 } EndTime { seconds: 1760543059 } }
2025-10-15T15:44:19.680219Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:314: actor# [4:7561474847179471171:2120] Handle TEvProposeTransaction
2025-10-15T15:44:19.680273Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:237: actor# [4:7561474847179471171:2120] TxId# 281474976715664 ProcessProposeTransaction
2025-10-15T15:44:19.680334Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:256: actor# [4:7561474847179471171:2120] Cookie# 0 userReqId# "" txid# 281474976715664 SEND to# [4:7561474864359341951:3201]
2025-10-15T15:44:19.683558Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1673: Actor# [4:7561474864359341951:3201] txid# 281474976715664 Bootstrap EvSchemeRequest record: Transaction { ModifyScheme { WorkingDir: "/Root" OperationType: ESchemeOpDropTable Drop { Name: "Int16Table" } SuccessOnNotExist: false } } UserToken: "" DatabaseName: "/Root" RequestType: "" PeerName: "ipv6:[::1]:42272" 
2025-10-15T15:44:19.683617Z node 4 :TX_PROXY DEBUG: schemereq.cpp:613: Actor# [4:7561474864359341951:3201] txid# 281474976715664 Bootstrap, UserSID: <empty> CheckAdministrator: 0 CheckDatabaseAdministrator: 0
2025-10-15T15:44:19.683701Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1728: Actor# [4:7561474864359341951:3201] txid# 281474976715664 TEvNavigateKeySet requested from SchemeCache
2025-10-15T15:44:19.684063Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1561: Actor# [4:7561474864359341951:3201] txid# 281474976715664 HANDLE EvNavigateKeySetResult TFlatSchemeReq marker# P5 ErrorCount# 0
2025-10-15T15:44:19.684183Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1608: Actor# [4:7561474864359341951:3201] HANDLE EvNavigateKeySetResult, txid# 281474976715664 shardToRequest# 72057594046644480 DomainKey# [OwnerId: 72057594046644480, LocalPathId: 1] DomainInfo.Params# Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 RedirectRequired# true
2025-10-15T15:44:19.684216Z node 4 :TX_PROXY DEBUG: schemereq.cpp:103: Actor# [4:7561474864359341951:3201] txid# 281474976715664 SEND to# 72057594046644480 shardToRequest {TEvModifySchemeTransaction txid# 281474976715664 TabletId# 72057594046644480}
2025-10-15T15:44:19.684364Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1463: Actor# [4:7561474864359341951:3201] txid# 281474976715664 HANDLE EvClientConnected
2025-10-15T15:44:19.690224Z node 4 :TX_PROXY DEBUG: schemereq.cpp:1485: Actor# [4:7561474864359341951:3201] txid# 281474976715664 Status StatusAccepted HANDLE {TEvModifySchemeTransactionResult Status# StatusAccepted txid# 281474976715664}
2025-10-15T15:44:19.690286Z node 4 :TX_PROXY DEBUG: schemereq.cpp:593: Actor# [4:7561474864359341951:3201] txid# 281474976715664 SEND to# [4:7561474864359341950:2327] Source {TEvProposeTransactionStatus txid# 281474976715664 Status# 53}
2025-10-15T15:44:19.744512Z node 4 :HIVE WARN: hive_impl.cpp:516: HIVE#72057594037968897 Handle TEvLocal::TEvTabletStatus from node 4, TabletId: 72075186224037888 not found
2025-10-15T15:44:19.744573Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:37: [CreateImport] [4:7561474864359342035:2383] [0] Allocate txId
2025-10-15T15:44:19.744834Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:374: actor# [4:7561474847179471171:2120] Handle TEvAllocateTxId
2025-10-15T15:44:19.744927Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:44: [CreateImport] [4:7561474864359342035:2383] [281474976715665] TEvTxUserProxy::TEvAllocateTxIdResult
2025-10-15T15:44:19.744952Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [CreateImport] [4:7561474864359342035:2383] [281474976715665] Resolve database: name# /Root
2025-10-15T15:44:19.746241Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [CreateImport] [4:7561474864359342035:2383] [281474976715665] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:19.746287Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [CreateImport] [4:7561474864359342035:2383] [281474976715665] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:19.748011Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:130: TImport::TTxCreate: DoExecute
2025-10-15T15:44:19.748290Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:254: TImport::TTxCreate: Reply: status# SUCCESS, error# 
2025-10-15T15:44:19.749683Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:238: TImport::TTxCreate: DoComplete
2025-10-15T15:44:19.749780Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:19.749793Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:880: TImport::TTxProgress: Resume: id# 281474976715665, itemIdx# (empty maybe)
2025-10-15T15:44:19.749842Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:906: TImport::TTxProgress: Resume: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: <Invalid> State: GetScheme SubState: AllocateTxId WaitTxId: 0 SrcPath:  SrcPrefix: Int16Table Issue: '' }
2025-10-15T15:44:19.749903Z node 4 :IMPORT INFO: schemeshard_import__create.cpp:406: TImport::TTxProgress: Get scheme: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: <Invalid> State: GetScheme SubState: AllocateTxId WaitTxId: 0 SrcPath:  SrcPrefix: Int16Table Issue: '' }
2025-10-15T15:44:19.750016Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
2025-10-15T15:44:19.750145Z node 4 :TX_PROXY DEBUG: rpc_import.cpp:60: [CreateImport] [4:7561474864359342035:2383] [281474976715665] Handle TEvImport::TEvCreateImportResponse: record# Entry { Id: 281474976715665 Status: SUCCESS Progress: PROGRESS_PREPARING ImportFromS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_prefix: "Int16Table" destination_path: "/Root/Int16Table" } } StartTime { seconds: 1760543059 } }
2025-10-15T15:44:19.758793Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [GetImport] [4:7561474864359342053:2384] [0] Resolve database: name# /Root
2025-10-15T15:44:19.759209Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [GetImport] [4:7561474864359342053:2384] [0] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:19.759235Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [GetImport] [4:7561474864359342053:2384] [0] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:19.773256Z node 4 :TX_PROXY DEBUG: rpc_get_operation.cpp:238: [GetImport] [4:7561474864359342053:2384] [0] Handle TEvImport::TEvGetImportResponse: record# Entry { Id: 281474976715665 Status: SUCCESS Progress: PROGRESS_PREPARING ImportFromS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_prefix: "Int16Table" destination_path: "/Root/Int16Table" } } StartTime { seconds: 1760543059 } }
REQUEST: HEAD /test_bucket/Int16Table/metadata.json HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 451A20EA-F2B1-4D6B-B1EF-9F3206FF2745
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=3ae8ce83dccbf5ddc91eca2743609a2076dc2b8170aaf950d189de95dcf2f557
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/metadata.json / 112
2025-10-15T15:44:19.775538Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:334: HandleMetadata TEvExternalStorage::TEvHeadObjectResponse: self# [4:7561474864359342052:2210], result# HeadObjectResult { ETag: 76f4ee5e33488a709e6617d55e35023a ContentLength: 112 }
REQUEST: GET /test_bucket/Int16Table/metadata.json HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 9419C52B-AE5B-4360-861D-5E3A31F0C799
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=3408c7100da78d4f00a0dba673dbc31d5374fa0a95a8c0d2a229ae5be78b02ad
content-type: application/xml
range: bytes=0-111
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/metadata.json / 112
2025-10-15T15:44:19.779999Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:433: HandleMetadata TEvExternalStorage::TEvGetObjectResponse: self# [4:7561474864359342052:2210], result# 76f4ee5e33488a709e6617d55e35023a
REQUEST: HEAD /test_bucket/Int16Table/metadata.json.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: D01C0201-5A0C-4FA0-B08D-2A0CCF30BFA0
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=d7950aeb838dd50898647dfd9be2f12a4c529315627684b71a7b2de8e0dc9eb5
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/metadata.json.sha256 / 78
2025-10-15T15:44:19.821024Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:215: HandleChecksum TEvExternalStorage::TEvHeadObjectResponse: self# [4:7561474864359342052:2210], result# HeadObjectResult { ETag: a752ffefd243149e4ba0f14a6c51433d ContentLength: 78 }
REQUEST: GET /test_bucket/Int16Table/metadata.json.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: DFED3968-C526-40E8-B881-41DA84440E9D
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=a3e296b1c21ae69889143274151c1327fec4167bf46aaa14216fa7eb6510783d
content-type: application/xml
range: bytes=0-77
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/metadata.json.sha256 / 78
2025-10-15T15:44:19.824653Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:230: HandleChecksum TEvExternalStorage::TEvGetObjectResponse: self# [4:7561474864359342052:2210], result# a752ffefd243149e4ba0f14a6c51433d
REQUEST: HEAD /test_bucket/Int16Table/scheme.pb HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: F2ED0364-5320-47DC-AAA9-FB128A2AD83A
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=0a507519ce4b00838b0b7d1a7b3d3fc291a0f08873fc198bfee14bbca56a5322
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/scheme.pb / 357
2025-10-15T15:44:19.859121Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:348: HandleScheme TEvExternalStorage::TEvHeadObjectResponse: self# [4:7561474864359342052:2210], result# HeadObjectResult { ETag: 02a3286ef848949eb63dfb5fbd5d980e ContentLength: 357 }
REQUEST: GET /test_bucket/Int16Table/scheme.pb HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 1B40AF11-844A-40D5-BB8A-A9491CD4B672
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=05a554a12bde1ebcc4d918b6af37901e3316a488779b31dc1a4dac9fbc55784f
content-type: application/xml
range: bytes=0-356
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/scheme.pb / 357
2025-10-15T15:44:19.864092Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:477: HandleScheme TEvExternalStorage::TEvGetObjectResponse: self# [4:7561474864359342052:2210], result# 02a3286ef848949eb63dfb5fbd5d980e
REQUEST: HEAD /test_bucket/Int16Table/scheme.pb.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 66A35F4D-6F2A-462F-926C-E20D2071ED20
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=8fd16ff7adc7cb20ebf15daa8f38fab96b0d450526bf4c2aa82658e25a562b45
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/scheme.pb.sha256 / 74
2025-10-15T15:44:19.905188Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:215: HandleChecksum TEvExternalStorage::TEvHeadObjectResponse: self# [4:7561474864359342052:2210], result# HeadObjectResult { ETag: c4e4a9a8e105c0ee2dd936ff3d63fbd6 ContentLength: 74 }
REQUEST: GET /test_bucket/Int16Table/scheme.pb.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: B4C121BA-E6D9-4AC3-AB54-22BB2CAD3BF2
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=f56f6b86eb116420cecea2231feaa4ba7f40de56d25d4975af5dc7aa7efad54c
content-type: application/xml
range: bytes=0-73
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/scheme.pb.sha256 / 74
2025-10-15T15:44:19.914569Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:230: HandleChecksum TEvExternalStorage::TEvGetObjectResponse: self# [4:7561474864359342052:2210], result# c4e4a9a8e105c0ee2dd936ff3d63fbd6
REQUEST: HEAD /test_bucket/Int16Table/permissions.pb HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 9CFE1E47-93D5-4A3F-831B-BF99BEDF9B91
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=d3311e9efc681dcc8bf47892e6eca7cc0ef18aa177ea4b922478a3bd2ac05e89
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/permissions.pb / 43
2025-10-15T15:44:19.962238Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:379: HandlePermissions TEvExternalStorage::TEvHeadObjectResponse: self# [4:7561474864359342052:2210], result# HeadObjectResult { ETag: 248a8c16c4235c5d1cfac1b4cbe728a2 ContentLength: 43 }
REQUEST: GET /test_bucket/Int16Table/permissions.pb HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 10A94911-AB76-4612-A42A-BEEA0199414B
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=387297daa575ee2036c77a97d03d66fb9719e91ff50a33dedf4f4965670904c3
content-type: application/xml
range: bytes=0-42
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154419Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/permissions.pb / 43
2025-10-15T15:44:19.973479Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:536: HandlePermissions TEvExternalStorage::TEvGetObjectResponse: self# [4:7561474864359342052:2210], result# 248a8c16c4235c5d1cfac1b4cbe728a2
2025-10-15T15:44:19.985189Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [GetImport] [4:7561474864359342080:2385] [0] Resolve database: name# /Root
2025-10-15T15:44:19.989349Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [GetImport] [4:7561474864359342080:2385] [0] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:19.989395Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [GetImport] [4:7561474864359342080:2385] [0] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:20.009344Z node 4 :TX_PROXY DEBUG: rpc_get_operation.cpp:238: [GetImport] [4:7561474864359342080:2385] [0] Handle TEvImport::TEvGetImportResponse: record# Entry { Id: 281474976715665 Status: SUCCESS Progress: PROGRESS_PREPARING ImportFromS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_prefix: "Int16Table" destination_path: "/Root/Int16Table" } } StartTime { seconds: 1760543059 } }
REQUEST: HEAD /test_bucket/Int16Table/permissions.pb.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: BF3A30D6-1660-40AF-AA2B-01B8CF683783
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=8860f35229d6d380990276d550faee7c59452214fb54fff1d7139e3dc6c89e9d
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154420Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/permissions.pb.sha256 / 79
2025-10-15T15:44:20.014236Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:215: HandleChecksum TEvExternalStorage::TEvHeadObjectResponse: self# [4:7561474864359342052:2210], result# HeadObjectResult { ETag: a72c6b7914a36d6a221c2b316440ecb3 ContentLength: 79 }
REQUEST: GET /test_bucket/Int16Table/permissions.pb.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: 1E7C9B82-BE17-405F-B1B7-3EB0AD478C3A
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=a7733e47492684ea0510021a608862e4e9466347a7aa5247f8615bfeaa16638a
content-type: application/xml
range: bytes=0-78
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154420Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/permissions.pb.sha256 / 79
2025-10-15T15:44:20.018299Z node 4 :IMPORT DEBUG: schemeshard_import_getters.cpp:230: HandleChecksum TEvExternalStorage::TEvGetObjectResponse: self# [4:7561474864359342052:2210], result# a72c6b7914a36d6a221c2b316440ecb3
2025-10-15T15:44:20.018337Z node 4 :IMPORT INFO: schemeshard_import_getters.cpp:694: Reply: self# [4:7561474864359342052:2210], success# 1, error# 
2025-10-15T15:44:20.018421Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:20.018434Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:1000: TImport::TTxProgress: OnSchemeResult: id# 281474976715665, itemIdx# 0, success# 1
2025-10-15T15:44:20.018821Z node 4 :IMPORT INFO: schemeshard_import__create.cpp:640: TImport::TTxProgress: Allocate txId: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: <Invalid> State: CreateSchemeObject SubState: AllocateTxId WaitTxId: 0 SrcPath:  SrcPrefix: Int16Table Issue: '' }
2025-10-15T15:44:20.027135Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
2025-10-15T15:44:20.027247Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:20.027260Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:1171: TImport::TTxProgress: OnAllocateResult: txId# 281474976710762, id# 281474976715665
2025-10-15T15:44:20.027308Z node 4 :IMPORT INFO: schemeshard_import__create.cpp:430: TImport::TTxProgress: CreateTable propose: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: <Invalid> State: CreateSchemeObject SubState: Proposed WaitTxId: 0 SrcPath:  SrcPrefix: Int16Table Issue: '' }, txId# 281474976710762
2025-10-15T15:44:20.027455Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
2025-10-15T15:44:20.029112Z node 4 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpCreateTable, opId: 281474976710762:0, at schemeshard:  72057594046644480, first GetDB called at:  (GetDB first called at /home/runner/actions_runner/_work/ydb/ydb/ydb/core/tx/schemeshard/schemeshard__operation_create_table.cpp:684)
2025-10-15T15:44:20.032972Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:20.033004Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:1267: TImport::TTxProgress: OnModifyResult: txId# 281474976710762, status# StatusAccepted
2025-10-15T15:44:20.033208Z node 4 :IMPORT INFO: schemeshard_import__create.cpp:654: TImport::TTxProgress: Wait for completion: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: [OwnerId: 72057594046644480, LocalPathId: 9] State: CreateSchemeObject SubState: Subscribed WaitTxId: 281474976710762 SrcPath:  SrcPrefix: Int16Table Issue: '' }
2025-10-15T15:44:20.037948Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
2025-10-15T15:44:20.083397Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:20.083420Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:1425: TImport::TTxProgress: OnNotifyResult: txId# 281474976710762
2025-10-15T15:44:20.083496Z node 4 :IMPORT INFO: schemeshard_import__create.cpp:640: TImport::TTxProgress: Allocate txId: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: [OwnerId: 72057594046644480, LocalPathId: 9] State: Transferring SubState: AllocateTxId WaitTxId: 0 SrcPath:  SrcPrefix: Int16Table Issue: '' }
2025-10-15T15:44:20.084553Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
2025-10-15T15:44:20.084621Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:20.084632Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:1171: TImport::TTxProgress: OnAllocateResult: txId# 281474976710763, id# 281474976715665
2025-10-15T15:44:20.084686Z node 4 :IMPORT INFO: schemeshard_import__create.cpp:531: TImport::TTxProgress: Restore propose: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: [OwnerId: 72057594046644480, LocalPathId: 9] State: Transferring SubState: Proposed WaitTxId: 0 SrcPath:  SrcPrefix: Int16Table Issue: '' }, txId# 281474976710763
2025-10-15T15:44:20.085273Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
2025-10-15T15:44:20.085650Z node 4 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpRestore, opId: 281474976710763:0, at schemeshard:  72057594046644480, first GetDB called at:  (GetDB first called at /home/runner/actions_runner/_work/ydb/ydb/ydb/core/tx/schemeshard/schemeshard__operation_backup_restore_common.h:563)
2025-10-15T15:44:20.087028Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:20.087047Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:1267: TImport::TTxProgress: OnModifyResult: txId# 281474976710763, status# StatusAccepted
2025-10-15T15:44:20.087118Z node 4 :IMPORT INFO: schemeshard_import__create.cpp:654: TImport::TTxProgress: Wait for completion: info# { Id: 281474976715665 Uid: '' Kind: S3 DomainPathId: [OwnerId: 72057594046644480, LocalPathId: 1] UserSID: '(empty maybe)' State: Waiting Issue: '' Items: 1 }, item# { Idx: 0 DstPathName: '/Root/Int16Table' DstPathId: [OwnerId: 72057594046644480, LocalPathId: 9] State: Transferring SubState: Subscribed WaitTxId: 281474976710763 SrcPath:  SrcPrefix: Int16Table Issue: '' }
2025-10-15T15:44:20.088263Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
REQUEST: HEAD /test_bucket/Int16Table/data_00.csv HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: ECF348A3-7147-484C-AA37-14116D6E33BF
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=831e1459cc58cb90e71c72f495e561a16366816109cb502e8cfaa953962cb0c8
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154420Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/data_00.csv / 4
REQUEST: HEAD /test_bucket/Int16Table/data_00.csv.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: B94D058C-DD35-41D3-8A66-4864DF6C1EF5
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=097648425493655dc7e6a32c219ddf11a6e71f2b2b499a55dc7c27d54ebe3cac
content-type: application/xml
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154420Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/data_00.csv.sha256 / 76
REQUEST: GET /test_bucket/Int16Table/data_00.csv.sha256 HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: E13A794B-E1F5-43A0-81F4-16F62EF55975
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=db9868b2df2d6f7df2418e66c14754420c4b56bf4d6134627c02eece5b902257
content-type: application/xml
range: bytes=0-75
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154420Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/data_00.csv.sha256 / 76
REQUEST: GET /test_bucket/Int16Table/data_00.csv HTTP/1.1
HEADERS: 
Host: localhost:1839
Accept: */*
Connection: Upgrade, HTTP2-Settings
Upgrade: h2c
HTTP2-Settings: AAMAAABkAAQAoAAAAAIAAAAA
amz-sdk-invocation-id: D447A90E-FD50-448D-9A9D-CEBA78B5CAB9
amz-sdk-request: attempt=1
authorization: AWS4-HMAC-SHA256 Credential=test_key/20251015/us-east-1/s3/aws4_request, SignedHeaders=amz-sdk-invocation-id;amz-sdk-request;content-type;host;range;x-amz-api-version;x-amz-content-sha256;x-amz-date, Signature=7c7005bdb04709852ebe3d650a0b3b992865ed26f7597c58109813d1329d1c2d
content-type: application/xml
range: bytes=0-3
user-agent: aws-sdk-cpp/1.11.37 Linux/5.15.0-157-generic x86_64 Clang/20.1.8
x-amz-api-version: 2006-03-01
x-amz-content-sha256: e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date: 20251015T154420Z
S3_MOCK::HttpServeRead: /test_bucket/Int16Table/data_00.csv / 4
2025-10-15T15:44:20.173553Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:372: TImport::TTxProgress: DoExecute
2025-10-15T15:44:20.173578Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:1425: TImport::TTxProgress: OnNotifyResult: txId# 281474976710763
2025-10-15T15:44:20.175340Z node 4 :IMPORT DEBUG: schemeshard_import__create.cpp:396: TImport::TTxProgress: DoComplete
2025-10-15T15:44:20.418707Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:50: [GetImport] [4:7561474868654309563:2390] [0] Resolve database: name# /Root
2025-10-15T15:44:20.419110Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:66: [GetImport] [4:7561474868654309563:2390] [0] Handle TEvTxProxySchemeCache::TEvNavigateKeySetResult: request# { ErrorCount: 0 DatabaseName: /Root DomainOwnerId: 0 Instant: 0 ResultSet [{ Path: Root TableId: [72057594046644480:1:0] RequestType: ByPath Operation: OpPath RedirectRequired: true ShowPrivatePath: false SyncVersion: false Status: Ok Kind: KindPath DomainInfo { DomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] ResourcesDomainKey: [OwnerId: 72057594046644480, LocalPathId: 1] Params { Version: 1 PlanResolution: 7 Coordinators: 72057594046316545 TimeCastBucketsPerMediator: 2 Mediators: 72057594046382081 } ServerlessComputeResourcesMode: (empty maybe) Users: [] Groups: [] } }] }
2025-10-15T15:44:20.419138Z node 4 :TX_PROXY DEBUG: rpc_operation_request_base.h:106: [GetImport] [4:7561474868654309563:2390] [0] Send request: schemeShardId# 72057594046644480
2025-10-15T15:44:20.420508Z node 4 :TX_PROXY DEBUG: rpc_get_operation.cpp:238: [GetImport] [4:7561474868654309563:2390] [0] Handle TEvImport::TEvGetImportResponse: record# Entry { Id: 281474976715665 Status: SUCCESS Progress: PROGRESS_DONE ImportFromS3Settings { endpoint: "localhost:1839" scheme: HTTP bucket: "test_bucket" items { source_prefix: "Int16Table" destination_path: "/Root/Int16Table" } } StartTime { seconds: 1760543059 } EndTime { seconds: 1760543060 } }
2025-10-15T15:44:20.542130Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:352: actor# [4:7561474847179471171:2120] Handle TEvExecuteKqpTransaction
2025-10-15T15:44:20.542177Z node 4 :TX_PROXY DEBUG: proxy_impl.cpp:341: actor# [4:7561474847179471171:2120] TxId# 281474976715666 ProcessProposeKqpTransaction
2025-10-15T15:44:20.561774Z node 4 :METADATA_PROVIDER ERROR: log.cpp:841: fline=table_exists.cpp:59;actor=TTableExistsActor;event=timeout;self_id=[4:7561474847179471159:2263];send_to=[0:7307199536658146131:7762515];
2025-10-15T15:44:20.561847Z node 4 :METADATA_PROVIDER ERROR: log.cpp:841: fline=accessor_snapshot_base.cpp:71;action=cannot detect path existence;path=//Root/.metadata/initialization/migrations;error=timeout;
