2025-12-12 10:05:18,479 - INFO - ya.test.2060683  - pytest_runtest_setup: ####################################################################################################
2025-12-12 10:05:18,479 - INFO - ya.test.2060683  - pytest_runtest_setup: test_does_not_prevent_predicate_many_preceders_pmp_for_write_predicates
2025-12-12 10:05:18,479 - INFO - ya.test.2060683  - pytest_runtest_setup: ####################################################################################################
2025-12-12 10:05:18,479 - INFO - ya.test.2060683  - pytest_runtest_setup: Test setup
2025-12-12 10:05:18,481 - INFO - ya.test.2060683  - pytest_runtest_call: Test call (class_name: test_isolation.py::TestTransactionIsolation, test_name: test_does_not_prevent_predicate_many_preceders_pmp_for_write_predicates)
2025-12-12 10:05:18,481 - DEBUG - ydb.connection.2060683  - _prepare_call: RpcState(CreateSession, c4efa8ae-6772-4f13-aa1f-8624507d92d6, ghrun-llwi4fnhxu.auto.internal:27863): creating call state
2025-12-12 10:05:18,482 - DEBUG - ydb.connection.2060683  - _log_request: RpcState(CreateSession, c4efa8ae-6772-4f13-aa1f-8624507d92d6, ghrun-llwi4fnhxu.auto.internal:27863): request = { operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2025-12-12 10:05:18,484 - DEBUG - ydb.connection.2060683  - _log_response: RpcState(CreateSession, c4efa8ae-6772-4f13-aa1f-8624507d92d6, ghrun-llwi4fnhxu.auto.internal:27863): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.CreateSessionResult] { session_id: "ydb://session/3?node_id=1&id=OGZkZmQ0MDQtN2NkZmVjM2UtODcyYWJkZmMtYzE3YmYyY2Q=" } } } }
2025-12-12 10:05:18,485 - DEBUG - ydb.connection.2060683  - _prepare_call: RpcState(ExecuteSchemeQuery, 624c96f4-1494-43f1-8e33-8d75dda5c783, ghrun-llwi4fnhxu.auto.internal:27863): creating call state
2025-12-12 10:05:18,486 - DEBUG - ydb.connection.2060683  - _log_request: RpcState(ExecuteSchemeQuery, 624c96f4-1494-43f1-8e33-8d75dda5c783, ghrun-llwi4fnhxu.auto.internal:27863): request = { session_id: "ydb://session/3?node_id=1&id=OGZkZmQ0MDQtN2NkZmVjM2UtODcyYWJkZmMtYzE3YmYyY2Q=" yql_text: "create table test_does_not_prevent_predicate_many_preceders_pmp_for_write_predicates (id Int32, value Int32, primary key(id)); " operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2025-12-12 10:05:18,545 - DEBUG - ydb.connection.2060683  - _log_response: RpcState(ExecuteSchemeQuery, 624c96f4-1494-43f1-8e33-8d75dda5c783, ghrun-llwi4fnhxu.auto.internal:27863): response = { operation { ready: true status: SUCCESS } }
2025-12-12 10:05:18,546 - DEBUG - ydb.connection.2060683  - _prepare_call: RpcState(ExecuteDataQuery, 1541330e-fbdc-4109-b641-1396353c556e, ghrun-llwi4fnhxu.auto.internal:27863): creating call state
2025-12-12 10:05:18,553 - DEBUG - ydb.connection.2060683  - _log_request: RpcState(ExecuteDataQuery, 1541330e-fbdc-4109-b641-1396353c556e, ghrun-llwi4fnhxu.auto.internal:27863): request = { session_id: "ydb://session/3?node_id=1&id=OGZkZmQ0MDQtN2NkZmVjM2UtODcyYWJkZmMtYzE3YmYyY2Q=" tx_control { begin_tx { serializable_read_write { } } commit_tx: true } query { yql_text: "upsert into test_does_not_prevent_predicate_many_preceders_pmp_for_write_predicates (id, value) values (1, 10), (2, 20); " } operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2025-12-12 10:05:18,574 - DEBUG - ydb.connection.2060683  - _log_response: RpcState(ExecuteDataQuery, 1541330e-fbdc-4109-b641-1396353c556e, ghrun-llwi4fnhxu.auto.internal:27863): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.ExecuteQueryResult] { tx_meta { } } } } }
2025-12-12 10:05:18,589 - DEBUG - ydb.connection.2060683  - _prepare_call: RpcState(ExecuteDataQuery, ac793a89-8afb-4895-bf54-acb75af978ff, ghrun-llwi4fnhxu.auto.internal:27863): creating call state
2025-12-12 10:05:18,595 - DEBUG - ydb.connection.2060683  - _log_request: RpcState(ExecuteDataQuery, ac793a89-8afb-4895-bf54-acb75af978ff, ghrun-llwi4fnhxu.auto.internal:27863): request = { session_id: "ydb://session/3?node_id=1&id=OGZkZmQ0MDQtN2NkZmVjM2UtODcyYWJkZmMtYzE3YmYyY2Q=" tx_control { begin_tx { serializable_read_write { } } } query { yql_text: "update test_does_not_prevent_predicate_many_preceders_pmp_for_write_predicates set value = value + 10;" } operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2025-12-12 10:05:18,720 - DEBUG - ydb.connection.2060683  - _log_response: RpcState(ExecuteDataQuery, ac793a89-8afb-4895-bf54-acb75af978ff, ghrun-llwi4fnhxu.auto.internal:27863): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.ExecuteQueryResult] { tx_meta { id: "01kc90b9fx52pzd80s4enctppz" } } } } }
2025-12-12 10:05:18,722 - DEBUG - ydb.connection.2060683  - _prepare_call: RpcState(ExecuteDataQuery, 40fbbe12-b623-4236-bff2-05b5fb06a57a, ghrun-llwi4fnhxu.auto.internal:27863): creating call state
2025-12-12 10:05:18,725 - DEBUG - ydb.connection.2060683  - _log_request: RpcState(ExecuteDataQuery, 40fbbe12-b623-4236-bff2-05b5fb06a57a, ghrun-llwi4fnhxu.auto.internal:27863): request = { session_id: "ydb://session/3?node_id=1&id=OGZkZmQ0MDQtN2NkZmVjM2UtODcyYWJkZmMtYzE3YmYyY2Q=" tx_control { begin_tx { serializable_read_write { } } } query { yql_text: "delete from test_does_not_prevent_predicate_many_preceders_pmp_for_write_predicates where value = 20;" } operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2025-12-12 10:05:18,779 - DEBUG - ydb.connection.2060683  - _log_response: RpcState(ExecuteDataQuery, 40fbbe12-b623-4236-bff2-05b5fb06a57a, ghrun-llwi4fnhxu.auto.internal:27863): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.ExecuteQueryResult] { tx_meta { id: "01kc90b9hq7fs51432xm80pc3x" } } } } }
2025-12-12 10:05:18,779 - DEBUG - ydb.connection.2060683  - _prepare_call: RpcState(CommitTransaction, 74f24573-e748-47a2-a447-d49ad9e46bc5, ghrun-llwi4fnhxu.auto.internal:27863): creating call state
2025-12-12 10:05:18,780 - DEBUG - ydb.connection.2060683  - _log_request: RpcState(CommitTransaction, 74f24573-e748-47a2-a447-d49ad9e46bc5, ghrun-llwi4fnhxu.auto.internal:27863): request = { session_id: "ydb://session/3?node_id=1&id=OGZkZmQ0MDQtN2NkZmVjM2UtODcyYWJkZmMtYzE3YmYyY2Q=" tx_id: "01kc90b9fx52pzd80s4enctppz" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2025-12-12 10:05:18,818 - DEBUG - ydb.connection.2060683  - _log_response: RpcState(CommitTransaction, 74f24573-e748-47a2-a447-d49ad9e46bc5, ghrun-llwi4fnhxu.auto.internal:27863): response = { operation { ready: true status: SUCCESS result { [type.googleapis.com/Ydb.Table.CommitTransactionResult] { } } } }
2025-12-12 10:05:18,825 - DEBUG - ydb.connection.2060683  - _prepare_call: RpcState(CommitTransaction, cf2aa9aa-933d-4c6f-93e2-20e9672e16aa, ghrun-llwi4fnhxu.auto.internal:27863): creating call state
2025-12-12 10:05:18,826 - DEBUG - ydb.connection.2060683  - _log_request: RpcState(CommitTransaction, cf2aa9aa-933d-4c6f-93e2-20e9672e16aa, ghrun-llwi4fnhxu.auto.internal:27863): request = { session_id: "ydb://session/3?node_id=1&id=OGZkZmQ0MDQtN2NkZmVjM2UtODcyYWJkZmMtYzE3YmYyY2Q=" tx_id: "01kc90b9hq7fs51432xm80pc3x" operation_params { operation_timeout { seconds: 600 } cancel_after { seconds: 600 } } }
2025-12-12 10:05:18,847 - DEBUG - ydb.connection.2060683  - _log_response: RpcState(CommitTransaction, cf2aa9aa-933d-4c6f-93e2-20e9672e16aa, ghrun-llwi4fnhxu.auto.internal:27863): response = { operation { ready: true status: ABORTED issues { message: "Transaction locks invalidated. Table: `/Root/test_does_not_prevent_predicate_many_preceders_pmp_for_write_predicates`" issue_code: 2001 severity: 1 } } }
2025-12-12 10:05:18,851 - INFO - ya.test.2060683  - pytest_runtest_teardown: Test teardown
