2025-12-09T03:18:06.117944Z node 10 :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-12-09T03:18:06.118095Z node 10 :METADATA_PROVIDER ERROR: log.cpp:841: fline=accessor_snapshot_base.cpp:71;action=cannot detect path existence;path=//Root/.metadata/initialization/migrations;error=incorrect path status: LookupError;
test_client.cpp: SetPath # /home/runner/.ya/build/build_root/av6y/0010b8/r3tmp/tmpT7ERW3/pdisk_1.dat
2025-12-09T03:18:06.216100Z node 10 :IMPORT WARN: schemeshard_import.cpp:307: Table profiles were not loaded
2025-12-09T03:18:06.231272Z node 10 :HIVE WARN: node_info.cpp:25: HIVE#72057594037968897 Node(10, (0,0,0,0)) VolatileState: Unknown -> Disconnected
2025-12-09T03:18:06.231297Z node 10 :HIVE WARN: node_info.cpp:25: HIVE#72057594037968897 Node(10, (0,0,0,0)) VolatileState: Disconnected -> Connecting
2025-12-09T03:18:06.239253Z node 10 :HIVE WARN: node_info.cpp:25: HIVE#72057594037968897 Node(10, (0,0,0,0)) VolatileState: Connecting -> Connected
TServer::EnableGrpc on GrpcPort 24701, node 10
2025-12-09T03:18:06.316677Z node 10 :NET_CLASSIFIER WARN: net_classifier.cpp:190: distributable config is empty, broken or outdated, will use file: (empty maybe)
2025-12-09T03:18:06.316690Z node 10 :NET_CLASSIFIER WARN: net_classifier.cpp:196: will try to initialize from file: (empty maybe)
2025-12-09T03:18:06.316692Z node 10 :NET_CLASSIFIER WARN: net_classifier.cpp:204: failed to initialize from file: (empty maybe)
2025-12-09T03:18:06.316720Z node 10 :NET_CLASSIFIER ERROR: net_classifier.cpp:228: got bad distributable configuration
2025-12-09T03:18:06.318508Z node 10 :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
TClient is connected to server localhost:20130
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-12-09T03:18:06.351583Z node 10 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpAlterSubDomain, opId: 281474976710657: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-12-09T03:18:06.367580Z node 10 :FLAT_TX_SCHEMESHARD WARN: schemeshard__notify.cpp:122: NotifyTxCompletion, unknown transaction, txId: 281474976710657, at schemeshard: 72057594046644480
2025-12-09T03:18:06.716614Z node 10 :FLAT_TX_SCHEMESHARD WARN: schemeshard__operation.cpp:183: Operation part proposed ok, but propose itself is undo unsafe, suboperation type: ESchemeOpCreateTable, opId: 281474976710658: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:690)
2025-12-09T03:18:07.117036Z node 10 :TX_CONVEYOR ERROR: log.cpp:841: fline=service.h:53;problem=unexpected event for task executor;ev_type=NActors::TEvents::TEvWakeup;
2025-12-09T03:18:07.732675Z node 10 :TX_DATASHARD INFO: datashard.cpp:372: TDataShard::OnActivateExecutor: tablet 72075186224037888 actor [10:7581692252198209810:2320]
2025-12-09T03:18:07.732746Z node 10 :TX_DATASHARD DEBUG: datashard__init.cpp:661: TxInitSchema.Execute
2025-12-09T03:18:07.742584Z node 10 :TX_DATASHARD DEBUG: datashard__init.cpp:727: TxInitSchema.Complete
2025-12-09T03:18:07.742608Z node 10 :TX_DATASHARD DEBUG: datashard__init.cpp:50: TDataShard::TTxInit::Execute
2025-12-09T03:18:07.742807Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:1322: LoadChangeRecords: QueueSize: 0, at tablet: 72075186224037888
2025-12-09T03:18:07.742813Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:1378: LoadLockChangeRecords at tablet: 72075186224037888
2025-12-09T03:18:07.742819Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:1427: LoadChangeRecordCommits at tablet: 72075186224037888
2025-12-09T03:18:07.742880Z node 10 :TX_DATASHARD DEBUG: datashard__init.cpp:94: TDataShard::TTxInit::Complete
2025-12-09T03:18:07.742887Z node 10 :TX_DATASHARD DEBUG: datashard__init.cpp:102: TDataShard::TTxInitRestored::Execute
2025-12-09T03:18:07.742909Z node 10 :TX_DATASHARD DEBUG: datashard__init.cpp:142: DataShard 72075186224037888 persisting started state actor id [10:7581692252198209831:2320] in generation 1
2025-12-09T03:18:07.750271Z node 10 :TX_DATASHARD DEBUG: datashard__init.cpp:151: TDataShard::TTxInitRestored::Complete
2025-12-09T03:18:07.750311Z node 10 :TX_DATASHARD INFO: datashard.cpp:416: Switched to work state WaitScheme tabletId 72075186224037888
2025-12-09T03:18:07.750339Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:456: 72075186224037888 not sending time cast registration request in state WaitScheme: missing processing params
2025-12-09T03:18:07.750351Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:1257: Change sender created: at tablet: 72075186224037888, actorId: [10:7581692252198209835:2321]
2025-12-09T03:18:07.750354Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:1262: Trying to activate change sender: at tablet: 72075186224037888
2025-12-09T03:18:07.750360Z node 10 :TX_DATASHARD INFO: datashard.cpp:1279: Cannot activate change sender: at tablet: 72075186224037888, state: WaitScheme
2025-12-09T03:18:07.750363Z node 10 :TX_DATASHARD DEBUG: cdc_stream_heartbeat.cpp:87: [CdcStreamHeartbeat] Emit heartbeats: at tablet# 72075186224037888
2025-12-09T03:18:07.750391Z node 10 :TX_DATASHARD DEBUG: datashard__cleanup_in_rs.cpp:96: TTxCheckInReadSets::Execute at 72075186224037888
2025-12-09T03:18:07.750412Z node 10 :TX_DATASHARD DEBUG: datashard__cleanup_in_rs.cpp:139: TTxCheckInReadSets::Complete found 0 read sets to remove in 72075186224037888
2025-12-09T03:18:07.750415Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:16: TTxProgressTransaction::Execute at 72075186224037888
2025-12-09T03:18:07.750418Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:272: GetNextActiveOp at 72075186224037888 active 0 active planned 0 immediate 0 planned 0
2025-12-09T03:18:07.750431Z node 10 :TX_DATASHARD INFO: datashard__progress_tx.cpp:48: No tx to execute at 72075186224037888 TxInFly 0
2025-12-09T03:18:07.750434Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:119: TTxProgressTransaction::Complete at 72075186224037888
2025-12-09T03:18:07.750795Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:3720: Server connected at leader tablet# 72075186224037888, clientId# [10:7581692247903242272:2496], serverId# [10:7581692247903242274:2497], sessionId# [0:0:0]
2025-12-09T03:18:07.750819Z node 10 :TX_DATASHARD DEBUG: datashard__propose_tx_base.cpp:33: TTxProposeTransactionBase::Execute at 72075186224037888
2025-12-09T03:18:07.750873Z node 10 :TX_DATASHARD DEBUG: check_scheme_tx_unit.cpp:133: Propose scheme transaction at tablet 72075186224037888 txId 281474976710658 ssId 72057594046644480 seqNo 2:1
2025-12-09T03:18:07.750889Z node 10 :TX_DATASHARD DEBUG: check_scheme_tx_unit.cpp:221: Prepared scheme transaction txId 281474976710658 at tablet 72075186224037888
2025-12-09T03:18:07.751240Z node 10 :TX_DATASHARD DEBUG: datashard_subdomain_path_id.cpp:180: Discovered subdomain [OwnerId: 72057594046644480, LocalPathId: 1] state, outOfSpace = 0 at datashard 72075186224037888
2025-12-09T03:18:07.759643Z node 10 :TX_DATASHARD DEBUG: datashard__propose_tx_base.cpp:152: TTxProposeTransactionBase::Complete at 72075186224037888
2025-12-09T03:18:07.759686Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:466: 72075186224037888 not sending time cast registration request in state WaitScheme
2025-12-09T03:18:07.775514Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:3720: Server connected at leader tablet# 72075186224037888, clientId# [10:7581692252198209860:2696], serverId# [10:7581692252198209863:2699], sessionId# [0:0:0]
2025-12-09T03:18:07.776987Z node 10 :TX_DATASHARD DEBUG: datashard__plan_step.cpp:69: Planned transaction txId 281474976710658 at step 1765250287815 at tablet 72075186224037888 { Transactions { TxId: 281474976710658 AckTo { RawX1: 0 RawX2: 0 } } Step: 1765250287815 MediatorID: 72057594046382081 TabletID: 72075186224037888 }
2025-12-09T03:18:07.777013Z node 10 :TX_DATASHARD DEBUG: cdc_stream_heartbeat.cpp:87: [CdcStreamHeartbeat] Emit heartbeats: at tablet# 72075186224037888
2025-12-09T03:18:07.777061Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:16: TTxProgressTransaction::Execute at 72075186224037888
2025-12-09T03:18:07.777068Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:272: GetNextActiveOp at 72075186224037888 active 0 active planned 0 immediate 0 planned 1
2025-12-09T03:18:07.777083Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:333: Found ready operation [1765250287815:281474976710658] in PlanQueue unit at 72075186224037888
2025-12-09T03:18:07.777161Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:634: LoadTxDetails at 72075186224037888 loaded tx from db 1765250287815:281474976710658 keys extracted: 0
2025-12-09T03:18:07.777208Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:272: GetNextActiveOp at 72075186224037888 (dry run) active 1 active planned 1 immediate 0 planned 1
2025-12-09T03:18:07.777235Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:16: TTxProgressTransaction::Execute at 72075186224037888
2025-12-09T03:18:07.777254Z node 10 :TX_DATASHARD INFO: create_table_unit.cpp:69: Trying to CREATE TABLE at 72075186224037888 tableId# [OwnerId: 72057594046644480, LocalPathId: 2] schema version# 1
2025-12-09T03:18:07.777399Z node 10 :TX_DATASHARD INFO: datashard.cpp:474: Send registration request to time cast Ready tabletId 72075186224037888 mediators count is 1 coordinators count is 1 buckets per mediator 2
2025-12-09T03:18:07.777504Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:272: GetNextActiveOp at 72075186224037888 (dry run) active 0 active planned 0 immediate 0 planned 0
2025-12-09T03:18:07.783228Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:3752: Got TEvMediatorTimecast::TEvRegisterTabletResult at 72075186224037888 time 0
2025-12-09T03:18:07.783250Z node 10 :TX_DATASHARD DEBUG: cdc_stream_heartbeat.cpp:87: [CdcStreamHeartbeat] Emit heartbeats: at tablet# 72075186224037888
2025-12-09T03:18:07.783260Z node 10 :TX_DATASHARD DEBUG: datashard_subdomain_path_id.cpp:180: Discovered subdomain [OwnerId: 72057594046644480, LocalPathId: 1] state, outOfSpace = 0 at datashard 72075186224037888
2025-12-09T03:18:07.788202Z node 10 :TX_DATASHARD DEBUG: datashard__plan_step.cpp:98: Sending '{TEvPlanStepAccepted TabletId# 72075186224037888 step# 1765250287815}
2025-12-09T03:18:07.788229Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:119: TTxProgressTransaction::Complete at 72075186224037888
2025-12-09T03:18:07.788240Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:119: TTxProgressTransaction::Complete at 72075186224037888
2025-12-09T03:18:07.788246Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:1262: Trying to activate change sender: at tablet: 72075186224037888
2025-12-09T03:18:07.788256Z node 10 :TX_DATASHARD INFO: datashard.cpp:1300: Change sender activated: at tablet: 72075186224037888
2025-12-09T03:18:07.788277Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:808: Complete [1765250287815 : 281474976710658] from 72075186224037888 at tablet 72075186224037888 send result to client [10:7581692247903241854:2218], exec latency: 0 ms, propose latency: 11 ms
2025-12-09T03:18:07.788288Z node 10 :TX_DATASHARD INFO: datashard.cpp:1597: 72075186224037888 Sending notify to schemeshard 72057594046644480 txId 281474976710658 state Ready TxInFly 0
2025-12-09T03:18:07.788297Z node 10 :TX_DATASHARD DEBUG: cdc_stream_heartbeat.cpp:87: [CdcStreamHeartbeat] Emit heartbeats: at tablet# 72075186224037888
2025-12-09T03:18:07.788318Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:3770: Got TEvMediatorTimecast::TEvSubscribeReadStepResult at 72075186224037888 coordinator 72057594046316545 last step 0 next step 1765250287822
2025-12-09T03:18:07.789935Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:2963: Handle TEvSchemaChangedResult 281474976710658  datashard 72075186224037888 state Ready
2025-12-09T03:18:07.789954Z node 10 :TX_DATASHARD DEBUG: datashard__schema_changed.cpp:22: 72075186224037888 Got TEvSchemaChangedResult from SS at 72075186224037888
FALLBACK_ACTOR_LOGGING;priority=TRACE;component=2100;fline=native.cpp:71;event=parsing;size=10280;columns=12;
FALLBACK_ACTOR_LOGGING;priority=DEBUG;component=2100;fline=native.cpp:110;event=serialize;size=10280;columns=12;
2025-12-09T03:18:07.802320Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:3720: Server connected at leader tablet# 72075186224037888, clientId# [10:7581692252198209911:2737], serverId# [10:7581692252198209912:2738], sessionId# [0:0:0]
2025-12-09T03:18:07.802374Z node 10 :TX_DATASHARD INFO: datashard__op_rows.cpp:26: TTxDirectBase(36) Execute: at tablet# 72075186224037888
2025-12-09T03:18:07.806425Z node 10 :TX_DATASHARD INFO: datashard__op_rows.cpp:80: TTxDirectBase(36) Complete: at tablet# 72075186224037888
2025-12-09T03:18:07.806446Z node 10 :TX_DATASHARD DEBUG: cdc_stream_heartbeat.cpp:87: [CdcStreamHeartbeat] Emit heartbeats: at tablet# 72075186224037888
SUCCESS
Upsert done: 0.017543s
2025-12-09T03:18:07.828021Z node 10 :TX_DATASHARD DEBUG: datashard__propose_tx_base.cpp:33: TTxProposeTransactionBase::Execute at 72075186224037888
2025-12-09T03:18:07.828063Z node 10 :TX_DATASHARD DEBUG: check_snapshot_tx_unit.cpp:153: Prepared Snapshot transaction txId 281474976710659 at tablet 72075186224037888
2025-12-09T03:18:07.829765Z node 10 :TX_DATASHARD DEBUG: datashard__propose_tx_base.cpp:152: TTxProposeTransactionBase::Complete at 72075186224037888
2025-12-09T03:18:07.830769Z node 10 :TX_DATASHARD DEBUG: datashard__plan_step.cpp:69: Planned transaction txId 281474976710659 at step 1765250287878 at tablet 72075186224037888 { Transactions { TxId: 281474976710659 AckTo { RawX1: 0 RawX2: 0 } } Step: 1765250287878 MediatorID: 72057594046382081 TabletID: 72075186224037888 }
2025-12-09T03:18:07.830778Z node 10 :TX_DATASHARD DEBUG: cdc_stream_heartbeat.cpp:87: [CdcStreamHeartbeat] Emit heartbeats: at tablet# 72075186224037888
2025-12-09T03:18:07.830805Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:16: TTxProgressTransaction::Execute at 72075186224037888
2025-12-09T03:18:07.830820Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:272: GetNextActiveOp at 72075186224037888 active 0 active planned 0 immediate 0 planned 1
2025-12-09T03:18:07.830827Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:333: Found ready operation [1765250287878:281474976710659] in PlanQueue unit at 72075186224037888
2025-12-09T03:18:07.830867Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:634: LoadTxDetails at 72075186224037888 loaded tx from db 1765250287878:281474976710659 keys extracted: 0
2025-12-09T03:18:07.830941Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:272: GetNextActiveOp at 72075186224037888 (dry run) active 0 active planned 0 immediate 0 planned 0
2025-12-09T03:18:07.833112Z node 10 :TX_DATASHARD DEBUG: datashard__plan_step.cpp:98: Sending '{TEvPlanStepAccepted TabletId# 72075186224037888 step# 1765250287878}
2025-12-09T03:18:07.833146Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:119: TTxProgressTransaction::Complete at 72075186224037888
2025-12-09T03:18:07.833170Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:808: Complete [1765250287878 : 281474976710659] from 72075186224037888 at tablet 72075186224037888 send result to client [10:7581692252198209929:2749], exec latency: 0 ms, propose latency: 2 ms
2025-12-09T03:18:07.833182Z node 10 :TX_DATASHARD DEBUG: cdc_stream_heartbeat.cpp:87: [CdcStreamHeartbeat] Emit heartbeats: at tablet# 72075186224037888
2025-12-09T03:18:07.834407Z node 10 :KQP_EXECUTER ERROR: kqp_planner.cpp:124: TxId: 281474976710660. Ctx: { TraceId: 01kc0hvj6199vgxtthrbncdw0t, Database: , SessionId: ydb://session/3?node_id=10&id=NDJmNjYxMmItOGY0NmIyNGQtNDY5NWUyZDgtYjgzMGIwYTY=, PoolId: , DatabaseId: /Root, IsStreamingQuery: 0}. Database not set, use /Root
2025-12-09T03:18:07.838142Z node 10 :TX_DATASHARD INFO: datashard__kqp_scan.cpp:214: Start scan, at: [10:7581692252198209958:2080], tablet: [10:7581692252198209810:2320], scanId: 5, table: /Root/LogsX, gen: 1, deadline: 2025-12-09T03:28:07.835190Z
2025-12-09T03:18:07.838340Z node 10 :TX_DATASHARD DEBUG: datashard__kqp_scan.cpp:109: Got ScanDataAck, at: [10:7581692252198209958:2080], scanId: 5, table: /Root/LogsX, gen: 1, tablet: [10:7581692252198209810:2320], freeSpace: 8388608;limits:(bytes=0;chunks=0);
2025-12-09T03:18:07.838344Z node 10 :TX_DATASHARD DEBUG: datashard__kqp_scan.cpp:124: Wakeup driver at: [10:7581692252198209958:2080]
2025-12-09T03:18:07.838493Z node 10 :TX_DATASHARD DEBUG: datashard__kqp_scan.cpp:311: Range 0 of 1 exhausted: try next one. table: /Root/LogsX range: [(Utf8 : NULL, Timestamp : NULL) ; ()) next range: <none>
2025-12-09T03:18:07.838495Z node 10 :TX_DATASHARD DEBUG: datashard__kqp_scan.cpp:226: TableRanges is over, at: [10:7581692252198209958:2080], scanId: 5, table: /Root/LogsX
2025-12-09T03:18:07.838507Z node 10 :TX_DATASHARD DEBUG: datashard__kqp_scan.cpp:340: Finish scan, at: [10:7581692252198209958:2080], scanId: 5, table: /Root/LogsX, reason: Done, abortEvent: <none>
2025-12-09T03:18:07.838514Z node 10 :TX_DATASHARD DEBUG: datashard__kqp_scan.cpp:465: Send ScanData, from: [10:7581692252198209958:2080], to: [10:7581692252198209953:2331], scanId: 5, table: /Root/LogsX, bytes: 12600, rows: 100, page faults: 0, finished: 1, pageFault: 0
2025-12-09T03:18:07.838558Z node 10 :TX_DATASHARD DEBUG: datashard.cpp:4481: FullScan complete at 72075186224037888
2025-12-09T03:18:07.838604Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:16: TTxProgressTransaction::Execute at 72075186224037888
2025-12-09T03:18:07.838617Z node 10 :TX_DATASHARD DEBUG: datashard_pipeline.cpp:272: GetNextActiveOp at 72075186224037888 active 0 active planned 0 immediate 0 planned 0
2025-12-09T03:18:07.838627Z node 10 :TX_DATASHARD INFO: datashard__progress_tx.cpp:48: No tx to execute at 72075186224037888 TxInFly 0
2025-12-09T03:18:07.838636Z node 10 :TX_DATASHARD DEBUG: datashard__progress_tx.cpp:119: TTxProgressTransaction::Complete at 72075186224037888
2025-12-09T03:18:07.841378Z node 10 :KQP_RESOURCE_MANAGER WARN: kqp_snapshot_manager.cpp:238: KqpSnapshotManager: discarding snapshot; our snapshot: [step: 1765250287878, txId: 281474976710659] shutting down
2025-12-09T03:18:07.914439Z node 10 :KQP_EXECUTER ERROR: kqp_planner.cpp:124: TxId: 281474976710661. Ctx: { TraceId: 01kc0hvj7714bstqwdj9k2wdpc, Database: , SessionId: ydb://session/3?node_id=10&id=ZjQ5NDQxMi02YTM1MmY0Ny1kNzVhZTkxNi1iZjkwYTdmOQ==, PoolId: , DatabaseId: /Root, IsStreamingQuery: 0}. Database not set, use /Root
SUCCESS
count returned 100 rows
Negative (wrong format): BAD_REQUEST
Negative (wrong data): SCHEME_ERROR
FALLBACK_ACTOR_LOGGING;priority=TRACE;component=2100;fline=native.cpp:71;event=parsing;size=9432;columns=11;
FALLBACK_ACTOR_LOGGING;priority=DEBUG;component=2100;fline=native.cpp:110;event=serialize;size=9432;columns=11;
Negative (less columns): BAD_REQUEST
FALLBACK_ACTOR_LOGGING;priority=TRACE;component=2100;fline=native.cpp:71;event=parsing;size=10280;columns=12;
FALLBACK_ACTOR_LOGGING;priority=DEBUG;component=2100;fline=native.cpp:110;event=serialize;size=10280;columns=12;
Negative (reordered columns): BAD_REQUEST
2025-12-09T03:18:07.925488Z node 10 :ARROW_HELPER ERROR: log.cpp:841: fline=arrow_helpers.cpp:154;event=cannot_parse;message=Invalid: Ran out of field metadata, likely malformed;schema_columns_count=12;schema_columns=timestamp,resource_type,resource_id,uid,level,message,json_payload,ingested_at,saved_at,request_id,flt,dbl;
2025-12-09T03:18:07.927021Z node 10 :ARROW_HELPER ERROR: log.cpp:841: fline=arrow_helpers.cpp:154;event=cannot_parse;message=Serialization error: batch is not valid: Invalid: Offsets buffer size (bytes): 400 isn't large enough for length: 100;schema_columns_count=12;schema_columns=timestamp,resource_type,resource_id,uid,level,message,json_payload,ingested_at,saved_at,request_id,flt,dbl;
