2025-12-12 13:26:17,137 - INFO - ya.test - pytest_runtest_setup: ####################################################################################################
2025-12-12 13:26:17,137 - INFO - ya.test - pytest_runtest_setup: test_timestamp_simple_posix_insert[v2-common/simple_posix/test.tsv-tsv_with_names]
2025-12-12 13:26:17,137 - INFO - ya.test - pytest_runtest_setup: ####################################################################################################
2025-12-12 13:26:17,137 - INFO - ya.test - pytest_runtest_setup: Test setup
2025-12-12 13:26:17,214 - INFO - ya.test - pytest_runtest_call: Test call (class_name: test_format_setting.py::TestS3, test_name: test_timestamp_simple_posix_insert[v2-common/simple_posix/test.tsv-tsv_with_names])
2025-12-12 13:26:17,215 - DEBUG - botocore.hooks - _emit: Event choose-service-name: calling handler <function handle_service_name_alias at 0x7f3738f31010>
2025-12-12 13:26:17,218 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function add_generate_presigned_post at 0x7f373903cd10>
2025-12-12 13:26:17,218 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function lazy_call.<locals>._handler at 0x7f3737981610>
2025-12-12 13:26:17,218 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function add_generate_presigned_url at 0x7f373903ca10>
2025-12-12 13:26:17,222 - DEBUG - botocore.endpoint - create_endpoint: Setting s3 timeout as (60, 60)
2025-12-12 13:26:17,231 - DEBUG - botocore.client - _register_legacy_retries: Registering retry handlers for service: s3
2025-12-12 13:26:17,248 - DEBUG - botocore.utils - register: Registering S3 region redirector handler
2025-12-12 13:26:17,250 - DEBUG - boto3.resources.factory - load_from_definition: Loading s3:s3
2025-12-12 13:26:17,252 - DEBUG - boto3.resources.factory - load_from_definition: Loading s3:Bucket
2025-12-12 13:26:17,252 - DEBUG - boto3.resources.model - _load_name_with_category: Renaming Bucket attribute name
2025-12-12 13:26:17,254 - DEBUG - botocore.hooks - _emit: Event creating-resource-class.s3.Bucket: calling handler <function lazy_call.<locals>._handler at 0x7f3737982090>
2025-12-12 13:26:17,254 - DEBUG - boto3.resources.action - __call__: Calling s3:create_bucket with {'Bucket': 'fbucket', 'ACL': 'public-read'}
2025-12-12 13:26:17,256 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.CreateBucket: calling handler <function validate_bucket_name at 0x7f3738f32ed0>
2025-12-12 13:26:17,256 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.CreateBucket: calling handler <function remove_bucket_from_url_paths_from_model at 0x7f3738f59790>
2025-12-12 13:26:17,257 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.CreateBucket: calling handler <bound method S3RegionRedirectorv2.annotate_request_context of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,258 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.CreateBucket: calling handler <function generate_idempotent_uuid at 0x7f3738f32c90>
2025-12-12 13:26:17,259 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <function customize_endpoint_resolver_builtins at 0x7f3738f599d0>
2025-12-12 13:26:17,259 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <bound method S3RegionRedirectorv2.redirect_from_cache of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,260 - DEBUG - botocore.regions - construct_endpoint: Calling endpoint provider with parameters: {'Bucket': 'fbucket', 'Region': 'yandex', 'UseFIPS': False, 'UseDualStack': False, 'Endpoint': 'http://localhost:24309', 'ForcePathStyle': True, 'Accelerate': False, 'UseGlobalEndpoint': False, 'DisableAccessPoints': True, 'DisableMultiRegionAccessPoints': False, 'UseArnRegion': True}
2025-12-12 13:26:17,262 - DEBUG - botocore.regions - construct_endpoint: Endpoint provider result: http://localhost:24309/fbucket
2025-12-12 13:26:17,263 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selecting from endpoint provider's list of auth schemes: "sigv4". User selected auth scheme is: "None"
2025-12-12 13:26:17,264 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selected auth type "v4" as "v4" with signing context params: {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}
2025-12-12 13:26:17,265 - DEBUG - botocore.hooks - _emit: Event before-call.s3.CreateBucket: calling handler <function add_expect_header at 0x7f3738f33350>
2025-12-12 13:26:17,266 - DEBUG - botocore.hooks - _emit: Event before-call.s3.CreateBucket: calling handler <function add_recursion_detection_header at 0x7f3738f31250>
2025-12-12 13:26:17,266 - DEBUG - botocore.hooks - _emit: Event before-call.s3.CreateBucket: calling handler <function inject_api_version_header_if_needed at 0x7f3738f58dd0>
2025-12-12 13:26:17,267 - DEBUG - botocore.endpoint - make_request: Making request for OperationModel(name=CreateBucket) with params: {'url_path': '', 'query_string': {}, 'method': 'PUT', 'headers': {'x-amz-acl': 'public-read', 'User-Agent': 'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource'}, 'body': b'', 'auth_path': '/fbucket/', 'url': 'http://localhost:24309/fbucket', 'context': {'client_region': 'yandex', 'client_config': <botocore.config.Config object at 0x7f3737bc7ee0>, 'has_streaming_input': False, 'auth_type': 'v4', 's3_redirect': {'redirected': False, 'bucket': 'fbucket', 'params': {'Bucket': 'fbucket', 'ACL': 'public-read'}}, 'signing': {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}}}
2025-12-12 13:26:17,268 - DEBUG - botocore.hooks - _emit: Event request-created.s3.CreateBucket: calling handler <bound method RequestSigner.handler of <botocore.signers.RequestSigner object at 0x7f3737bc4a60>>
2025-12-12 13:26:17,270 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.CreateBucket: calling handler <bound method ClientCreator._default_s3_presign_to_sigv2 of <botocore.client.ClientCreator object at 0x7f3737f09690>>
2025-12-12 13:26:17,270 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.CreateBucket: calling handler <function set_operation_specific_signer at 0x7f3738f32b10>
2025-12-12 13:26:17,271 - DEBUG - botocore.hooks - _emit: Event before-sign.s3.CreateBucket: calling handler <function remove_arn_from_signing_path at 0x7f3738f59910>
2025-12-12 13:26:17,275 - DEBUG - botocore.auth - add_auth: Calculating signature using v4 auth.
2025-12-12 13:26:17,275 - DEBUG - botocore.auth - add_auth: CanonicalRequest:
PUT
/fbucket

host:localhost:24309
x-amz-acl:public-read
x-amz-content-sha256:e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date:20251212T132617Z

host;x-amz-acl;x-amz-content-sha256;x-amz-date
e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
2025-12-12 13:26:17,275 - DEBUG - botocore.auth - add_auth: StringToSign:
AWS4-HMAC-SHA256
20251212T132617Z
20251212/yandex/s3/aws4_request
7dfa464b241942659ca24927b60f4d9c8e02306eb09fc1aa58cb2a253eaeede7
2025-12-12 13:26:17,275 - DEBUG - botocore.auth - add_auth: Signature:
744e82e99562cd990a35f6ac963b6055c10995186caebdf00d76b431a665e416
2025-12-12 13:26:17,276 - DEBUG - botocore.hooks - _emit: Event request-created.s3.CreateBucket: calling handler <function add_retry_headers at 0x7f3738f596d0>
2025-12-12 13:26:17,276 - DEBUG - botocore.endpoint - _do_get_response: Sending http request: <AWSPreparedRequest stream_output=False, method=PUT, url=http://localhost:24309/fbucket, headers={'x-amz-acl': b'public-read', 'User-Agent': b'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource', 'X-Amz-Date': b'20251212T132617Z', 'X-Amz-Content-SHA256': b'e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855', 'Authorization': b'AWS4-HMAC-SHA256 Credential=key/20251212/yandex/s3/aws4_request, SignedHeaders=host;x-amz-acl;x-amz-content-sha256;x-amz-date, Signature=744e82e99562cd990a35f6ac963b6055c10995186caebdf00d76b431a665e416', 'amz-sdk-invocation-id': b'4cc0a937-1e0d-4f2b-9f2f-a6373cfe635f', 'amz-sdk-request': b'attempt=1', 'Content-Length': '0'}>
2025-12-12 13:26:17,290 - DEBUG - botocore.parsers - parse: Response headers: {'Server': 'Werkzeug/2.2.3 Python/3.12.9', 'Date': 'Fri, 12 Dec 2025 13:26:17 GMT', 'x-amzn-requestid': 'YUuKPvQm2agi56ENRL79rScA9OBSbBLyL1QUasqb35pmvHzOPrPZ', 'Content-Type': 'text/html; charset=utf-8', 'Content-Length': '161', 'Access-Control-Allow-Origin': '*', 'Connection': 'close'}
2025-12-12 13:26:17,291 - DEBUG - botocore.parsers - parse: Response body:
b'<CreateBucketResponse xmlns="http://s3.amazonaws.com/doc/2006-03-01"><CreateBucketResponse><Bucket>fbucket</Bucket></CreateBucketResponse></CreateBucketResponse>'
2025-12-12 13:26:17,292 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.CreateBucket: calling handler <botocore.retryhandler.RetryHandler object at 0x7f371ae35ff0>
2025-12-12 13:26:17,292 - DEBUG - botocore.retryhandler - __call__: No retry needed.
2025-12-12 13:26:17,292 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.CreateBucket: calling handler <bound method S3RegionRedirectorv2.redirect_from_error of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,293 - DEBUG - boto3.resources.action - __call__: Response: {'ResponseMetadata': {'RequestId': 'YUuKPvQm2agi56ENRL79rScA9OBSbBLyL1QUasqb35pmvHzOPrPZ', 'HTTPStatusCode': 200, 'HTTPHeaders': {'server': 'Werkzeug/2.2.3 Python/3.12.9', 'date': 'Fri, 12 Dec 2025 13:26:17 GMT', 'x-amzn-requestid': 'YUuKPvQm2agi56ENRL79rScA9OBSbBLyL1QUasqb35pmvHzOPrPZ', 'content-type': 'text/html; charset=utf-8', 'content-length': '161', 'access-control-allow-origin': '*', 'connection': 'close'}, 'RetryAttempts': 0}}
2025-12-12 13:26:17,293 - DEBUG - boto3.resources.collection - pages: Calling paginated s3:list_objects with {'Bucket': 'fbucket'}
2025-12-12 13:26:17,294 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function set_list_objects_encoding_type_url at 0x7f3738f587d0>
2025-12-12 13:26:17,295 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function validate_bucket_name at 0x7f3738f32ed0>
2025-12-12 13:26:17,295 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function remove_bucket_from_url_paths_from_model at 0x7f3738f59790>
2025-12-12 13:26:17,295 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <bound method S3RegionRedirectorv2.annotate_request_context of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,295 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function generate_idempotent_uuid at 0x7f3738f32c90>
2025-12-12 13:26:17,296 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <function customize_endpoint_resolver_builtins at 0x7f3738f599d0>
2025-12-12 13:26:17,296 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <bound method S3RegionRedirectorv2.redirect_from_cache of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,296 - DEBUG - botocore.regions - construct_endpoint: Calling endpoint provider with parameters: {'Bucket': 'fbucket', 'Region': 'yandex', 'UseFIPS': False, 'UseDualStack': False, 'Endpoint': 'http://localhost:24309', 'ForcePathStyle': True, 'Accelerate': False, 'UseGlobalEndpoint': False, 'DisableMultiRegionAccessPoints': False, 'UseArnRegion': True}
2025-12-12 13:26:17,298 - DEBUG - botocore.regions - construct_endpoint: Endpoint provider result: http://localhost:24309/fbucket
2025-12-12 13:26:17,298 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selecting from endpoint provider's list of auth schemes: "sigv4". User selected auth scheme is: "None"
2025-12-12 13:26:17,298 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selected auth type "v4" as "v4" with signing context params: {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}
2025-12-12 13:26:17,299 - DEBUG - botocore.hooks - _emit: Event before-call.s3.ListObjects: calling handler <function add_expect_header at 0x7f3738f33350>
2025-12-12 13:26:17,299 - DEBUG - botocore.hooks - _emit: Event before-call.s3.ListObjects: calling handler <function add_recursion_detection_header at 0x7f3738f31250>
2025-12-12 13:26:17,299 - DEBUG - botocore.hooks - _emit: Event before-call.s3.ListObjects: calling handler <function inject_api_version_header_if_needed at 0x7f3738f58dd0>
2025-12-12 13:26:17,299 - DEBUG - botocore.endpoint - make_request: Making request for OperationModel(name=ListObjects) with params: {'url_path': '', 'query_string': {'encoding-type': 'url'}, 'method': 'GET', 'headers': {'User-Agent': 'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource'}, 'body': b'', 'auth_path': '/fbucket/', 'url': 'http://localhost:24309/fbucket?encoding-type=url', 'context': {'client_region': 'yandex', 'client_config': <botocore.config.Config object at 0x7f3737bc7ee0>, 'has_streaming_input': False, 'auth_type': 'v4', 'encoding_type_auto_set': True, 's3_redirect': {'redirected': False, 'bucket': 'fbucket', 'params': {'Bucket': 'fbucket', 'EncodingType': 'url'}}, 'signing': {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}}}
2025-12-12 13:26:17,300 - DEBUG - botocore.hooks - _emit: Event request-created.s3.ListObjects: calling handler <bound method RequestSigner.handler of <botocore.signers.RequestSigner object at 0x7f3737bc4a60>>
2025-12-12 13:26:17,301 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.ListObjects: calling handler <bound method ClientCreator._default_s3_presign_to_sigv2 of <botocore.client.ClientCreator object at 0x7f3737f09690>>
2025-12-12 13:26:17,301 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.ListObjects: calling handler <function set_operation_specific_signer at 0x7f3738f32b10>
2025-12-12 13:26:17,301 - DEBUG - botocore.hooks - _emit: Event before-sign.s3.ListObjects: calling handler <function remove_arn_from_signing_path at 0x7f3738f59910>
2025-12-12 13:26:17,302 - DEBUG - botocore.auth - add_auth: Calculating signature using v4 auth.
2025-12-12 13:26:17,302 - DEBUG - botocore.auth - add_auth: CanonicalRequest:
GET
/fbucket
encoding-type=url
host:localhost:24309
x-amz-content-sha256:e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date:20251212T132617Z

host;x-amz-content-sha256;x-amz-date
e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
2025-12-12 13:26:17,302 - DEBUG - botocore.auth - add_auth: StringToSign:
AWS4-HMAC-SHA256
20251212T132617Z
20251212/yandex/s3/aws4_request
3ec8a9012eb028b42eee16aa925aa1697c1a9e40d13e3661058cc30b092584d2
2025-12-12 13:26:17,303 - DEBUG - botocore.auth - add_auth: Signature:
66e33c0b10f025a2f9d788c5e60b81d5a01ca94c49cb6092be1b213a608ea365
2025-12-12 13:26:17,303 - DEBUG - botocore.hooks - _emit: Event request-created.s3.ListObjects: calling handler <function add_retry_headers at 0x7f3738f596d0>
2025-12-12 13:26:17,303 - DEBUG - botocore.endpoint - _do_get_response: Sending http request: <AWSPreparedRequest stream_output=False, method=GET, url=http://localhost:24309/fbucket?encoding-type=url, headers={'User-Agent': b'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource', 'X-Amz-Date': b'20251212T132617Z', 'X-Amz-Content-SHA256': b'e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855', 'Authorization': b'AWS4-HMAC-SHA256 Credential=key/20251212/yandex/s3/aws4_request, SignedHeaders=host;x-amz-content-sha256;x-amz-date, Signature=66e33c0b10f025a2f9d788c5e60b81d5a01ca94c49cb6092be1b213a608ea365', 'amz-sdk-invocation-id': b'df6cbd75-bdd5-45d1-b427-7bba50e9f3a1', 'amz-sdk-request': b'attempt=1'}>
2025-12-12 13:26:17,310 - DEBUG - botocore.parsers - parse: Response headers: {'Server': 'Werkzeug/2.2.3 Python/3.12.9', 'Date': 'Fri, 12 Dec 2025 13:26:17 GMT', 'x-amzn-requestid': 'kHpPMkWtYltDnbHP5yvBPpO3USCFbh8sONfcRw5raelhcdOY7wZD', 'Content-Type': 'text/html; charset=utf-8', 'Content-Length': '984', 'Access-Control-Allow-Origin': '*', 'Connection': 'close'}
2025-12-12 13:26:17,310 - DEBUG - botocore.parsers - parse: Response body:
b'<?xml version="1.0" encoding="UTF-8"?><ListBucketResult xmlns="http://s3.amazonaws.com/doc/2006-03-01/"><Name>fbucket</Name><MaxKeys>1000</MaxKeys><EncodingType>url</EncodingType><IsTruncated>false</IsTruncated><Contents><Key>common/simple_posix/test.csv</Key><LastModified>2025-12-12T13:26:15.000Z</LastModified><ETag>&#34;c458d53aa4505a223ff0a684a9962801&#34;</ETag><Size>88</Size><StorageClass>STANDARD</StorageClass><Owner><ID>75aa57f09aa0c8caeab4f8c24e99d10f8e7faeebf76c078efc7c6caea54ba06a</ID><DisplayName>webfile</DisplayName></Owner></Contents><Contents><Key>timestamp/simple_posix/csv_with_names/ptjudq7r5kb8t5hf82g6_0_SRn8LfXe2EqBYNRIohGdwC7buKHVvQng.csv</Key><LastModified>2025-12-12T13:26:16.000Z</LastModified><ETag>&#34;43689889ad7ac9e81fca6638a46214b0&#34;</ETag><Size>104</Size><StorageClass>STANDARD</StorageClass><Owner><ID>75aa57f09aa0c8caeab4f8c24e99d10f8e7faeebf76c078efc7c6caea54ba06a</ID><DisplayName>webfile</DisplayName></Owner></Contents></ListBucketResult>'
2025-12-12 13:26:17,312 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.ListObjects: calling handler <botocore.retryhandler.RetryHandler object at 0x7f371ae35ff0>
2025-12-12 13:26:17,313 - DEBUG - botocore.retryhandler - __call__: No retry needed.
2025-12-12 13:26:17,313 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.ListObjects: calling handler <bound method S3RegionRedirectorv2.redirect_from_error of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,313 - DEBUG - botocore.hooks - _emit: Event after-call.s3.ListObjects: calling handler <function decode_list_object at 0x7f3738f58890>
2025-12-12 13:26:17,314 - DEBUG - boto3.resources.factory - load_from_definition: Loading s3:ObjectSummary
2025-12-12 13:26:17,314 - DEBUG - boto3.resources.model - _load_name_with_category: Renaming ObjectSummary attribute key
2025-12-12 13:26:17,315 - DEBUG - botocore.hooks - _emit: Event creating-resource-class.s3.ObjectSummary: calling handler <function lazy_call.<locals>._handler at 0x7f3737982210>
2025-12-12 13:26:17,316 - DEBUG - boto3.resources.action - __call__: Calling s3:delete_objects with {'Bucket': 'fbucket', 'Delete': {'Objects': [{'Key': 'common/simple_posix/test.csv'}, {'Key': 'timestamp/simple_posix/csv_with_names/ptjudq7r5kb8t5hf82g6_0_SRn8LfXe2EqBYNRIohGdwC7buKHVvQng.csv'}]}}
2025-12-12 13:26:17,317 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.DeleteObjects: calling handler <function validate_bucket_name at 0x7f3738f32ed0>
2025-12-12 13:26:17,317 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.DeleteObjects: calling handler <function remove_bucket_from_url_paths_from_model at 0x7f3738f59790>
2025-12-12 13:26:17,317 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.DeleteObjects: calling handler <bound method S3RegionRedirectorv2.annotate_request_context of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,317 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.DeleteObjects: calling handler <function generate_idempotent_uuid at 0x7f3738f32c90>
2025-12-12 13:26:17,318 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <function customize_endpoint_resolver_builtins at 0x7f3738f599d0>
2025-12-12 13:26:17,318 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <bound method S3RegionRedirectorv2.redirect_from_cache of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,318 - DEBUG - botocore.regions - construct_endpoint: Calling endpoint provider with parameters: {'Bucket': 'fbucket', 'Region': 'yandex', 'UseFIPS': False, 'UseDualStack': False, 'Endpoint': 'http://localhost:24309', 'ForcePathStyle': True, 'Accelerate': False, 'UseGlobalEndpoint': False, 'DisableMultiRegionAccessPoints': False, 'UseArnRegion': True}
2025-12-12 13:26:17,318 - DEBUG - botocore.regions - construct_endpoint: Endpoint provider result: http://localhost:24309/fbucket
2025-12-12 13:26:17,320 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selecting from endpoint provider's list of auth schemes: "sigv4". User selected auth scheme is: "None"
2025-12-12 13:26:17,321 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selected auth type "v4" as "v4" with signing context params: {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}
2025-12-12 13:26:17,322 - DEBUG - botocore.hooks - _emit: Event before-call.s3.DeleteObjects: calling handler <function escape_xml_payload at 0x7f3738f328d0>
2025-12-12 13:26:17,323 - DEBUG - botocore.hooks - _emit: Event before-call.s3.DeleteObjects: calling handler <function add_expect_header at 0x7f3738f33350>
2025-12-12 13:26:17,323 - DEBUG - botocore.hooks - _emit: Event before-call.s3.DeleteObjects: calling handler <function add_recursion_detection_header at 0x7f3738f31250>
2025-12-12 13:26:17,323 - DEBUG - botocore.hooks - _emit: Event before-call.s3.DeleteObjects: calling handler <function inject_api_version_header_if_needed at 0x7f3738f58dd0>
2025-12-12 13:26:17,324 - DEBUG - botocore.endpoint - make_request: Making request for OperationModel(name=DeleteObjects) with params: {'url_path': '?delete', 'query_string': {}, 'method': 'POST', 'headers': {'User-Agent': 'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource', 'Content-MD5': 'mpnDjxkPwOz5KnvhBzQoJA=='}, 'body': b'<Delete xmlns="http://s3.amazonaws.com/doc/2006-03-01/"><Object><Key>common/simple_posix/test.csv</Key></Object><Object><Key>timestamp/simple_posix/csv_with_names/ptjudq7r5kb8t5hf82g6_0_SRn8LfXe2EqBYNRIohGdwC7buKHVvQng.csv</Key></Object></Delete>', 'auth_path': '/fbucket/', 'url': 'http://localhost:24309/fbucket?delete', 'context': {'client_region': 'yandex', 'client_config': <botocore.config.Config object at 0x7f3737bc7ee0>, 'has_streaming_input': False, 'auth_type': 'v4', 's3_redirect': {'redirected': False, 'bucket': 'fbucket', 'params': {'Bucket': 'fbucket', 'Delete': {'Objects': [{'Key': 'common/simple_posix/test.csv'}, {'Key': 'timestamp/simple_posix/csv_with_names/ptjudq7r5kb8t5hf82g6_0_SRn8LfXe2EqBYNRIohGdwC7buKHVvQng.csv'}]}}}, 'signing': {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}, 'checksum': {'request_algorithm': 'conditional-md5'}}}
2025-12-12 13:26:17,325 - DEBUG - botocore.hooks - _emit: Event request-created.s3.DeleteObjects: calling handler <bound method RequestSigner.handler of <botocore.signers.RequestSigner object at 0x7f3737bc4a60>>
2025-12-12 13:26:17,325 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.DeleteObjects: calling handler <bound method ClientCreator._default_s3_presign_to_sigv2 of <botocore.client.ClientCreator object at 0x7f3737f09690>>
2025-12-12 13:26:17,325 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.DeleteObjects: calling handler <function set_operation_specific_signer at 0x7f3738f32b10>
2025-12-12 13:26:17,326 - DEBUG - botocore.hooks - _emit: Event before-sign.s3.DeleteObjects: calling handler <function remove_arn_from_signing_path at 0x7f3738f59910>
2025-12-12 13:26:17,326 - DEBUG - botocore.auth - add_auth: Calculating signature using v4 auth.
2025-12-12 13:26:17,327 - DEBUG - botocore.auth - add_auth: CanonicalRequest:
POST
/fbucket
delete=
content-md5:mpnDjxkPwOz5KnvhBzQoJA==
host:localhost:24309
x-amz-content-sha256:f002cc8ef74d08017770fb70fdae6b9122954baf58cccbb0da6dce4c5cad18fe
x-amz-date:20251212T132617Z

content-md5;host;x-amz-content-sha256;x-amz-date
f002cc8ef74d08017770fb70fdae6b9122954baf58cccbb0da6dce4c5cad18fe
2025-12-12 13:26:17,327 - DEBUG - botocore.auth - add_auth: StringToSign:
AWS4-HMAC-SHA256
20251212T132617Z
20251212/yandex/s3/aws4_request
3d3e8ebf6311f6187920f122c6cc2f1abf1f47d60bb56c3b0c5f448533a6b67f
2025-12-12 13:26:17,327 - DEBUG - botocore.auth - add_auth: Signature:
470591d5ca73e60b9c871c18ae861b883902d9900f6d227c1508313c6deebdb9
2025-12-12 13:26:17,328 - DEBUG - botocore.hooks - _emit: Event request-created.s3.DeleteObjects: calling handler <function add_retry_headers at 0x7f3738f596d0>
2025-12-12 13:26:17,328 - DEBUG - botocore.endpoint - _do_get_response: Sending http request: <AWSPreparedRequest stream_output=False, method=POST, url=http://localhost:24309/fbucket?delete, headers={'User-Agent': b'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource', 'Content-MD5': b'mpnDjxkPwOz5KnvhBzQoJA==', 'X-Amz-Date': b'20251212T132617Z', 'X-Amz-Content-SHA256': b'f002cc8ef74d08017770fb70fdae6b9122954baf58cccbb0da6dce4c5cad18fe', 'Authorization': b'AWS4-HMAC-SHA256 Credential=key/20251212/yandex/s3/aws4_request, SignedHeaders=content-md5;host;x-amz-content-sha256;x-amz-date, Signature=470591d5ca73e60b9c871c18ae861b883902d9900f6d227c1508313c6deebdb9', 'amz-sdk-invocation-id': b'0f0341a4-014a-436b-99c5-a106c5f46921', 'amz-sdk-request': b'attempt=1', 'Content-Length': '246'}>
2025-12-12 13:26:17,335 - DEBUG - botocore.parsers - parse: Response headers: {'Server': 'Werkzeug/2.2.3 Python/3.12.9', 'Date': 'Fri, 12 Dec 2025 13:26:17 GMT', 'x-amzn-requestid': 's0IHzvYKSPz0gkyVqhYE8JCUO19r71ZsKwMmzTO7CNpCVLKOqbET', 'Content-Type': 'text/html; charset=utf-8', 'Content-Length': '299', 'Access-Control-Allow-Origin': '*', 'Connection': 'close'}
2025-12-12 13:26:17,335 - DEBUG - botocore.parsers - parse: Response body:
b'<?xml version="1.0" encoding="UTF-8"?><DeleteResult xmlns="http://s3.amazonaws.com/doc/2006-03-01"><Deleted><Key>common/simple_posix/test.csv</Key></Deleted><Deleted><Key>timestamp/simple_posix/csv_with_names/ptjudq7r5kb8t5hf82g6_0_SRn8LfXe2EqBYNRIohGdwC7buKHVvQng.csv</Key></Deleted></DeleteResult>'
2025-12-12 13:26:17,336 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.DeleteObjects: calling handler <botocore.retryhandler.RetryHandler object at 0x7f371ae35ff0>
2025-12-12 13:26:17,337 - DEBUG - botocore.retryhandler - __call__: No retry needed.
2025-12-12 13:26:17,337 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.DeleteObjects: calling handler <bound method S3RegionRedirectorv2.redirect_from_error of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b126db0>>
2025-12-12 13:26:17,337 - DEBUG - boto3.resources.action - __call__: Response: {'ResponseMetadata': {'RequestId': 's0IHzvYKSPz0gkyVqhYE8JCUO19r71ZsKwMmzTO7CNpCVLKOqbET', 'HTTPStatusCode': 200, 'HTTPHeaders': {'server': 'Werkzeug/2.2.3 Python/3.12.9', 'date': 'Fri, 12 Dec 2025 13:26:17 GMT', 'x-amzn-requestid': 's0IHzvYKSPz0gkyVqhYE8JCUO19r71ZsKwMmzTO7CNpCVLKOqbET', 'content-type': 'text/html; charset=utf-8', 'content-length': '299', 'access-control-allow-origin': '*', 'connection': 'close'}, 'RetryAttempts': 0}, 'Deleted': [{'Key': 'common/simple_posix/test.csv'}, {'Key': 'timestamp/simple_posix/csv_with_names/ptjudq7r5kb8t5hf82g6_0_SRn8LfXe2EqBYNRIohGdwC7buKHVvQng.csv'}]}
2025-12-12 13:26:17,338 - DEBUG - botocore.hooks - _emit: Event choose-service-name: calling handler <function handle_service_name_alias at 0x7f3738f31010>
2025-12-12 13:26:17,341 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function add_generate_presigned_post at 0x7f373903cd10>
2025-12-12 13:26:17,341 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function lazy_call.<locals>._handler at 0x7f3737981610>
2025-12-12 13:26:17,341 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function add_generate_presigned_url at 0x7f373903ca10>
2025-12-12 13:26:17,345 - DEBUG - botocore.endpoint - create_endpoint: Setting s3 timeout as (60, 60)
2025-12-12 13:26:17,349 - DEBUG - botocore.client - _register_legacy_retries: Registering retry handlers for service: s3
2025-12-12 13:26:17,350 - DEBUG - botocore.utils - register: Registering S3 region redirector handler
2025-12-12 13:26:17,352 - DEBUG - s3transfer.utils - acquire: Acquiring 0
2025-12-12 13:26:17,352 - DEBUG - s3transfer.tasks - _wait_until_all_complete: UploadSubmissionTask(transfer_id=0, {'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f3737be10f0>}) about to wait for the following futures []
2025-12-12 13:26:17,353 - DEBUG - s3transfer.tasks - _wait_until_all_complete: UploadSubmissionTask(transfer_id=0, {'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f3737be10f0>}) done waiting for dependent futures
2025-12-12 13:26:17,353 - DEBUG - s3transfer.tasks - _execute_main: Executing task UploadSubmissionTask(transfer_id=0, {'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f3737be10f0>}) with kwargs {'client': <botocore.client.S3 object at 0x7f371ae30290>, 'config': <boto3.s3.transfer.TransferConfig object at 0x7f371ab17e40>, 'osutil': <s3transfer.utils.OSUtils object at 0x7f371ae30920>, 'request_executor': <s3transfer.futures.BoundedExecutor object at 0x7f3737bfe180>, 'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f3737be10f0>}
2025-12-12 13:26:17,353 - DEBUG - s3transfer.futures - submit: Submitting task PutObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'common/simple_posix/test.tsv', 'extra_args': {}}) to executor <s3transfer.futures.BoundedExecutor object at 0x7f3737bfe180> for transfer request: 0.
2025-12-12 13:26:17,354 - DEBUG - s3transfer.utils - acquire: Acquiring 0
2025-12-12 13:26:17,354 - DEBUG - s3transfer.tasks - _wait_until_all_complete: PutObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'common/simple_posix/test.tsv', 'extra_args': {}}) about to wait for the following futures []
2025-12-12 13:26:17,354 - DEBUG - s3transfer.utils - release: Releasing acquire 0/None
2025-12-12 13:26:17,355 - DEBUG - s3transfer.tasks - _wait_until_all_complete: PutObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'common/simple_posix/test.tsv', 'extra_args': {}}) done waiting for dependent futures
2025-12-12 13:26:17,355 - DEBUG - s3transfer.tasks - _execute_main: Executing task PutObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'common/simple_posix/test.tsv', 'extra_args': {}}) with kwargs {'client': <botocore.client.S3 object at 0x7f371ae30290>, 'fileobj': <s3transfer.utils.ReadFileChunk object at 0x7f3737be2770>, 'bucket': 'fbucket', 'key': 'common/simple_posix/test.tsv', 'extra_args': {}}
2025-12-12 13:26:17,357 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.PutObject: calling handler <function validate_ascii_metadata at 0x7f3738f33f50>
2025-12-12 13:26:17,357 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.PutObject: calling handler <function sse_md5 at 0x7f3738f32f90>
2025-12-12 13:26:17,357 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.PutObject: calling handler <function convert_body_to_file_like_object at 0x7f3738f58c50>
2025-12-12 13:26:17,357 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.PutObject: calling handler <function validate_bucket_name at 0x7f3738f32ed0>
2025-12-12 13:26:17,357 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.PutObject: calling handler <function remove_bucket_from_url_paths_from_model at 0x7f3738f59790>
2025-12-12 13:26:17,358 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.PutObject: calling handler <bound method S3RegionRedirectorv2.annotate_request_context of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b112590>>
2025-12-12 13:26:17,358 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.PutObject: calling handler <function generate_idempotent_uuid at 0x7f3738f32c90>
2025-12-12 13:26:17,358 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <function customize_endpoint_resolver_builtins at 0x7f3738f599d0>
2025-12-12 13:26:17,358 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <bound method S3RegionRedirectorv2.redirect_from_cache of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b112590>>
2025-12-12 13:26:17,359 - DEBUG - botocore.regions - construct_endpoint: Calling endpoint provider with parameters: {'Bucket': 'fbucket', 'Region': 'yandex', 'UseFIPS': False, 'UseDualStack': False, 'Endpoint': 'http://localhost:24309', 'ForcePathStyle': True, 'Accelerate': False, 'UseGlobalEndpoint': False, 'DisableMultiRegionAccessPoints': False, 'UseArnRegion': True}
2025-12-12 13:26:17,360 - DEBUG - botocore.regions - construct_endpoint: Endpoint provider result: http://localhost:24309/fbucket
2025-12-12 13:26:17,360 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selecting from endpoint provider's list of auth schemes: "sigv4". User selected auth scheme is: "None"
2025-12-12 13:26:17,361 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selected auth type "v4" as "v4" with signing context params: {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}
2025-12-12 13:26:17,361 - DEBUG - botocore.hooks - _emit: Event before-call.s3.PutObject: calling handler <function conditionally_calculate_md5 at 0x7f373914fe90>
2025-12-12 13:26:17,362 - DEBUG - botocore.hooks - _emit: Event before-call.s3.PutObject: calling handler <function add_expect_header at 0x7f3738f33350>
2025-12-12 13:26:17,362 - DEBUG - botocore.handlers - add_expect_header: Adding expect 100 continue header to request.
2025-12-12 13:26:17,362 - DEBUG - botocore.hooks - _emit: Event before-call.s3.PutObject: calling handler <function add_recursion_detection_header at 0x7f3738f31250>
2025-12-12 13:26:17,362 - DEBUG - botocore.hooks - _emit: Event before-call.s3.PutObject: calling handler <function inject_api_version_header_if_needed at 0x7f3738f58dd0>
2025-12-12 13:26:17,363 - DEBUG - botocore.endpoint - make_request: Making request for OperationModel(name=PutObject) with params: {'url_path': '/common/simple_posix/test.tsv', 'query_string': {}, 'method': 'PUT', 'headers': {'User-Agent': 'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80', 'Content-MD5': 'vdqA/FrJbh4r2Zw612Ukog==', 'Expect': '100-continue'}, 'body': <s3transfer.utils.ReadFileChunk object at 0x7f3737be2770>, 'auth_path': '/fbucket/common/simple_posix/test.tsv', 'url': 'http://localhost:24309/fbucket/common/simple_posix/test.tsv', 'context': {'client_region': 'yandex', 'client_config': <botocore.config.Config object at 0x7f371b017580>, 'has_streaming_input': True, 'auth_type': 'v4', 's3_redirect': {'redirected': False, 'bucket': 'fbucket', 'params': {'Bucket': 'fbucket', 'Key': 'common/simple_posix/test.tsv', 'Body': <s3transfer.utils.ReadFileChunk object at 0x7f3737be2770>}}, 'signing': {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}}}
2025-12-12 13:26:17,364 - DEBUG - botocore.hooks - _emit: Event request-created.s3.PutObject: calling handler <function signal_not_transferring at 0x7f3738219790>
2025-12-12 13:26:17,364 - DEBUG - botocore.hooks - _emit: Event request-created.s3.PutObject: calling handler <bound method RequestSigner.handler of <botocore.signers.RequestSigner object at 0x7f371b017d00>>
2025-12-12 13:26:17,364 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.PutObject: calling handler <bound method ClientCreator._default_s3_presign_to_sigv2 of <botocore.client.ClientCreator object at 0x7f371ab77a80>>
2025-12-12 13:26:17,365 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.PutObject: calling handler <function set_operation_specific_signer at 0x7f3738f32b10>
2025-12-12 13:26:17,365 - DEBUG - botocore.hooks - _emit: Event before-sign.s3.PutObject: calling handler <function remove_arn_from_signing_path at 0x7f3738f59910>
2025-12-12 13:26:17,366 - DEBUG - botocore.auth - add_auth: Calculating signature using v4 auth.
2025-12-12 13:26:17,366 - DEBUG - botocore.auth - add_auth: CanonicalRequest:
PUT
/fbucket/common/simple_posix/test.tsv

content-md5:vdqA/FrJbh4r2Zw612Ukog==
host:localhost:24309
x-amz-content-sha256:3af89fb9664a3c8737dc61b1feea0c49fed84675f47171bed53eff7056c4429a
x-amz-date:20251212T132617Z

content-md5;host;x-amz-content-sha256;x-amz-date
3af89fb9664a3c8737dc61b1feea0c49fed84675f47171bed53eff7056c4429a
2025-12-12 13:26:17,366 - DEBUG - botocore.auth - add_auth: StringToSign:
AWS4-HMAC-SHA256
20251212T132617Z
20251212/yandex/s3/aws4_request
e79353ce1d35fc62a3bd9e6af5dde000eb44a43cebdffe2cf0934d23a248c752
2025-12-12 13:26:17,366 - DEBUG - botocore.auth - add_auth: Signature:
49aa6f9794cffd50095eaf8694b5f59a6c29b9bb4593775b74c288440faf9c3d
2025-12-12 13:26:17,367 - DEBUG - botocore.hooks - _emit: Event request-created.s3.PutObject: calling handler <function signal_transferring at 0x7f3738219850>
2025-12-12 13:26:17,367 - DEBUG - botocore.hooks - _emit: Event request-created.s3.PutObject: calling handler <function add_retry_headers at 0x7f3738f596d0>
2025-12-12 13:26:17,367 - DEBUG - botocore.endpoint - _do_get_response: Sending http request: <AWSPreparedRequest stream_output=False, method=PUT, url=http://localhost:24309/fbucket/common/simple_posix/test.tsv, headers={'User-Agent': b'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80', 'Content-MD5': b'vdqA/FrJbh4r2Zw612Ukog==', 'Expect': b'100-continue', 'X-Amz-Date': b'20251212T132617Z', 'X-Amz-Content-SHA256': b'3af89fb9664a3c8737dc61b1feea0c49fed84675f47171bed53eff7056c4429a', 'Authorization': b'AWS4-HMAC-SHA256 Credential=key/20251212/yandex/s3/aws4_request, SignedHeaders=content-md5;host;x-amz-content-sha256;x-amz-date, Signature=49aa6f9794cffd50095eaf8694b5f59a6c29b9bb4593775b74c288440faf9c3d', 'amz-sdk-invocation-id': b'9cd9dad2-8f1b-4887-b4cc-e935fe471e64', 'amz-sdk-request': b'attempt=1', 'Content-Length': '88'}>
2025-12-12 13:26:17,369 - DEBUG - botocore.awsrequest - _send_output: Waiting for 100 Continue response.
2025-12-12 13:26:17,371 - DEBUG - botocore.awsrequest - _handle_expect_response: 100 Continue response seen, now sending request body.
2025-12-12 13:26:17,375 - DEBUG - botocore.parsers - parse: Response headers: {'Server': 'Werkzeug/2.2.3 Python/3.12.9', 'Date': 'Fri, 12 Dec 2025 13:26:17 GMT', 'ETag': '"bdda80fc5ac96e1e2bd99c3ad76524a2"', 'last-modified': 'Fri, 12 Dec 2025 13:26:17 GMT', 'Content-Length': '0', 'x-amzn-requestid': 'gCFXnL69ZL5VT8bcWSEgHOsFa1smQMJ3s6TwXJJres04oX6LoW7o', 'Content-Type': 'text/html; charset=utf-8', 'Access-Control-Allow-Origin': '*', 'Connection': 'close'}
2025-12-12 13:26:17,375 - DEBUG - botocore.parsers - parse: Response body:
b''
2025-12-12 13:26:17,376 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.PutObject: calling handler <botocore.retryhandler.RetryHandler object at 0x7f3737bffc10>
2025-12-12 13:26:17,377 - DEBUG - botocore.retryhandler - __call__: No retry needed.
2025-12-12 13:26:17,377 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.PutObject: calling handler <bound method S3RegionRedirectorv2.redirect_from_error of <botocore.utils.S3RegionRedirectorv2 object at 0x7f371b112590>>
2025-12-12 13:26:17,377 - DEBUG - s3transfer.utils - release: Releasing acquire 0/None
2025-12-12 13:26:17,379 - DEBUG - root - wait_bootstrap: Wait for node 1 to bootstrap
2025-12-12 13:26:17,409 - DEBUG - root - wait_bootstrap: Node 1 has been bootstrapped
2025-12-12 13:26:17,556 - DEBUG - root - create_query_impl: Request: content {
  type: ANALYTICS
  name: "simple"
  acl {
    visibility: PRIVATE
  }
  limits {
    execution_timeout {
    }
  }
  text: "\n            INSERT INTO bindings.`h5899168521978938860_test_timestamp_simple_posix_insertinsert_my_binding`\n            SELECT Unwrap(Time + Interval(\"P1D\")) as Time, Fruit, Price, Weight\n            FROM bindings.`h5899168521978938860_test_timestamp_simple_posix_insertmy_binding`\n            "
  syntax: YQL_V1
}
execute_mode: RUN
idempotency_key: "cf042a27-da96-4413-93ad-11b5239a0bce"

2025-12-12 13:26:17,579 - DEBUG - root - create_query_impl: Result: query_id: "ptqudq7r5iofj4fhn6d7"

2025-12-12 13:26:17,591 - DEBUG - root - describe_query: Result: query {
  meta {
    common {
      id: "ptqudq7r5iofj4fhn6d7"
      created_by: "root@builtin"
      modified_by: "root@builtin"
      created_at {
        seconds: 1765545977
        nanos: 561490000
      }
      modified_at {
        seconds: 1765545977
        nanos: 561490000
      }
      revision: 1
    }
    execute_mode: RUN
    status: STARTING
    last_job_query_revision: 1
    last_job_id: "ptjudq7r5iofh4qsuph7-ptqudq7r5iofj4fhn6d7"
    started_by: "root@builtin"
    submitted_at {
      seconds: 1765545977
      nanos: 561490000
    }
  }
  content {
    type: ANALYTICS
    name: "simple"
    acl {
      visibility: PRIVATE
    }
    limits {
      execution_timeout {
      }
    }
    text: "\n            INSERT INTO bindings.`h5899168521978938860_test_timestamp_simple_posix_insertinsert_my_binding`\n            SELECT Unwrap(Time + Interval(\"P1D\")) as Time, Fruit, Price, Weight\n            FROM bindings.`h5899168521978938860_test_timestamp_simple_posix_insertmy_binding`\n            "
    syntax: YQL_V1
  }
}

2025-12-12 13:26:18,102 - DEBUG - root - describe_query: Result: query {
  meta {
    common {
      id: "ptqudq7r5iofj4fhn6d7"
      created_by: "root@builtin"
      modified_by: "root@builtin"
      created_at {
        seconds: 1765545977
        nanos: 561490000
      }
      modified_at {
        seconds: 1765545977
        nanos: 561490000
      }
      revision: 1
    }
    started_at {
      seconds: 1765545977
      nanos: 766000000
    }
    finished_at {
      seconds: 1765545977
      nanos: 972000000
    }
    execute_mode: RUN
    status: COMPLETED
    last_job_query_revision: 1
    last_job_id: "ptjudq7r5iofh4qsuph7-ptqudq7r5iofj4fhn6d7"
    result_expire_at {
      seconds: 1765632377
      nanos: 751504000
    }
    started_by: "root@builtin"
    submitted_at {
      seconds: 1765545977
      nanos: 561490000
    }
  }
  content {
    type: ANALYTICS
    name: "simple"
    acl {
      visibility: PRIVATE
    }
    limits {
      execution_timeout {
      }
    }
    text: "\n            INSERT INTO bindings.`h5899168521978938860_test_timestamp_simple_posix_insertinsert_my_binding`\n            SELECT Unwrap(Time + Interval(\"P1D\")) as Time, Fruit, Price, Weight\n            FROM bindings.`h5899168521978938860_test_timestamp_simple_posix_insertmy_binding`\n            "
    syntax: YQL_V1
  }
  plan {
    json: "{\"Plan\":{\"Plans\":[{\"PlanNodeId\":5,\"Plans\":[{\"PlanNodeId\":4,\"Plans\":[{\"PlanNodeId\":3,\"Plans\":[{\"PlanNodeId\":2,\"Plans\":[{\"PlanNodeId\":1,\"Operators\":[{\"E-Size\":\"39.11111111\",\"Format\":\"tsv_with_names\",\"Name\":\"h5899168521978938860_test_timestamp_simple_posix_insertmy_binding\",\"Inputs\":[],\"Path\":\"common/simple_posix/test.tsv \",\"E-Rows\":\"0.8888888889\",\"ExternalDataSource\":\"h5899168521978938860_test_timestamp_simple_posix_insertfruitbucket\",\"ReadColumns\":[\"Fruit\",\"Price\",\"Time\",\"Weight\"],\"SourceType\":\"s3\",\"E-Cost\":\"88\"}],\"Node Type\":\"Source\"}],\"Node Type\":\"Stage\"}],\"Node Type\":\"Map\",\"PlanNodeType\":\"Connection\"}],\"Node Type\":\"Stage\"}],\"Operators\":[{\"Inputs\":[],\"ExternalDataSource\":\"h5899168521978938860_test_timestamp_simple_posix_insertfruitbucket\",\"Extension\":\".tsv\",\"Name\":\"Write h5899168521978938860_test_timestamp_simple_posix_insertfruitbucket\",\"SinkType\":\"s3\"}],\"Node Type\":\"Sink\"}],\"Node Type\":\"Query\",\"PlanNodeType\":\"Query\"},\"meta\":{\"version\":\"0.2\",\"type\":\"query\"}}"
  }
  statistics {
    json: "{\"Sink\":{\"Tasks\":{\"sum\":2,\"count\":2,\"avg\":1,\"max\":1,\"min\":1},\"CpuTimeUs\":{\"sum\":\"556us\",\"count\":2,\"avg\":\"278us\",\"max\":\"304us\",\"min\":\"252us\"},\"IngressBytes\":{\"sum\":88,\"count\":1,\"avg\":88,\"max\":88,\"min\":88},\"IngressRows\":{\"sum\":2,\"count\":1,\"avg\":2,\"max\":2,\"min\":2},\"InputBytes\":{\"sum\":41,\"count\":1,\"avg\":41,\"max\":41,\"min\":41},\"InputRows\":{\"sum\":2,\"count\":1,\"avg\":2,\"max\":2,\"min\":2},\"OutputBytes\":{\"sum\":41,\"count\":1,\"avg\":41,\"max\":41,\"min\":41},\"OutputRows\":{\"sum\":2,\"count\":1,\"avg\":2,\"max\":2,\"min\":2},\"EgressBytes\":{\"sum\":88,\"count\":1,\"avg\":88,\"max\":88,\"min\":88},\"EgressRows\":{\"sum\":2,\"count\":1,\"avg\":2,\"max\":2,\"min\":2},\"MaxMemoryUsage\":{\"sum\":211812352,\"count\":2,\"avg\":105906176,\"max\":210763776,\"min\":1048576}}}"
  }
  ast {
    data: "(\n(let $1 \'\"/local/h5899168521978938860_test_timestamp_simple_posix_insertfruitbucket\")\n(let $2 \'\"/local/h5899168521978938860_test_timestamp_simple_posix_insertmy_binding\")\n(let $3 (DataSource \'\"s3\" $1 $2))\n(let $4 \'\"Paths {\\n  Name: \\\"common\\\"\\n  Children {\\n    Name: \\\"simple_posix\\\"\\n    Children {\\n      Name: \\\"test.tsv\\\"\\n      Size: 88\\n      Read: true\\n    }\\n    IsDirectory: true\\n  }\\n  IsDirectory: true\\n}\\n\")\n(let $5 (Bool \'\"true\"))\n(let $6 \'\"cluster:default_/local/h5899168521978938860_test_timestamp_simple_posix_insertfruitbucket\")\n(let $7 (SecureParam $6))\n(let $8 (DataType \'Int32))\n(let $9 (StructType \'(\'\"Fruit\" (DataType \'String)) \'(\'\"Price\" $8) \'(\'\"Time\" (DataType \'Timestamp)) \'(\'\"Weight\" $8)))\n(let $10 \'(\'\"data.timestamp.formatname\" \'\"POSIX\"))\n(let $11 (S3ParseSettings world \'(\'((String $4) $5 (AsStruct))) $7 \'\"\" \'\"common/simple_posix/test.tsv \" \'\"tsv_with_names\" $9 (lambda \'($17) $5) \'($10)))\n(let $12 \'(\'(\'\"_logical_id\" \'579) \'(\'\"_id\" \'\"6e10781a-c3bc7c42-7d38b30c-8b8a101e\") \'(\'\"_wide_channels\" $9)))\n(let $13 (DqPhyStage \'((DqSource $3 $11)) (lambda \'($18) (block \'(\n  (let $19 (DqSourceWideWrap $18 $3 $9 \'(\'(\'format \'\"tsv_with_names\"))))\n  (let $20 (lambda \'($21 $22 $23 $24) $21 $22 (Unwrap (+ $23 (Interval \'\"86400000000\"))) $24))\n  (return (FromFlow (WideMap $19 $20)))\n))) $12))\n(let $14 (DqCnMap (TDqOutput $13 \'\"0\")))\n(let $15 (S3SinkSettings \'\"timestamp/simple_posix/tsv_with_names/\" \'(\'(\'\"multipart\" \'\"true\")) $7 \'\".tsv\" $9))\n(let $16 (DqPhyStage \'($14) (lambda \'($25) (block \'(\n  (let $26 \'($10 \'(\'\"data.datetime.formatname\" \'\"POSIX\") \'(\'\"file_size_limit\" \'\"52428800\")))\n  (return (FromFlow (S3SinkOutput (NarrowMap (ToFlow $25) (lambda \'($27 $28 $29 $30) (AsStruct \'(\'\"Fruit\" $27) \'(\'\"Price\" $28) \'(\'\"Time\" $29) \'(\'\"Weight\" $30)))) \'\"tsv_with_names\" \'() $26)))\n))) \'(\'(\'\"_logical_id\" \'659) \'(\'\"_id\" \'\"b589a29-f114a289-932aba74-146f6d42\")) \'((DqSink \'\"0\" (DataSink \'\"s3\" $1) $15))))\n(return (KqpPhysicalQuery \'((KqpPhysicalTx \'($13 $16) \'() \'() \'(\'(\'\"type\" \'\"generic\") \'(\'\"with_effects\")))) \'() \'(\'(\'\"type\" \'\"script\"))))\n)\n"
  }
  timeline {
    svg: "<svg width=\'1280\' height=\'146\' xmlns=\'http://www.w3.org/2000/svg\'>\n<clipPath id=\'clipTextPath\'><rect x=\'0\' y=\'0\' width=\'298\' height=\'146\'/></clipPath>\n\n<defs>\n\n<g id=\'icon_memory\'>\n  <path fill-rule=\'evenodd\' clip-rule=\'evenodd\' d=\'M5 3C3.89543 3 3 3.89543 3 5H1V7H3V9H1V11H3V13H1V15H3V17H1V19H3C3 20.1046 3.89543 21 5 21H9C10.1046 21 11 20.1046 11 19H13C13 20.1046 13.8954 21 15 21H19C20.1046 21 21 20.1046 21 19H23V17H21V15H23V13H21V11H23V9H21V7H23V5H21C21 3.89543 20.1046 3 19 3H15C13.8954 3 13 3.89543 13 5H11C11 3.89543 10.1046 3 9 3H5ZM11 7V9H13V7H11ZM11 11V13H13V11H11ZM11 15V17H13V15H11ZM5 5H9V19H5V5ZM15 5H19V19H15V5Z\' />\n</g>\n\n<g id=\'icon_cpu\'>\n  <path d=\'M13.9802 7.75H10.0102C8.76023 7.75 7.74023 8.76 7.74023 10.02V13.99C7.74023 15.24 8.75023 16.26 10.0102 16.26H13.9802C15.2302 16.26 16.2502 15.25 16.2502 13.99V10.02C16.2502 8.76 15.2402 7.75 13.9802 7.75ZM13.5002 12.98L12.6102 14.53C12.4802 14.76 12.2402 14.88 12.0002 14.88C11.8802 14.88 11.7502 14.85 11.6502 14.79C11.3102 14.6 11.1902 14.17 11.3902 13.83L12.0302 12.72H11.4702C11.0202 12.72 10.6502 12.52 10.4502 12.18C10.2502 11.84 10.2702 11.42 10.5002 11.03L11.3902 9.48C11.5902 9.14 12.0202 9.03 12.3502 9.22C12.6902 9.41 12.8102 9.84 12.6102 10.18L11.9702 11.29H12.5302C12.9802 11.29 13.3502 11.49 13.5502 11.83C13.7502 12.17 13.7302 12.59 13.5002 12.98Z\' />\n  <path d=\'M21.25 12.75C21.67 12.75 22 12.41 22 12C22 11.58 21.67 11.25 21.25 11.25H20V9.05H21.25C21.67 9.05 22 8.72 22 8.3C22 7.89 21.67 7.55 21.25 7.55H19.77C19.29 5.96 18.04 4.71 16.45 4.23V2.75C16.45 2.34 16.11 2 15.7 2C15.29 2 14.95 2.34 14.95 2.75V4H12.75V2.75C12.75 2.34 12.41 2 12 2C11.59 2 11.25 2.34 11.25 2.75V4H9.06V2.75C9.06 2.34 8.72 2 8.31 2C7.89 2 7.56 2.34 7.56 2.75V4.23C5.96 4.71 4.71 5.96 4.23 7.55H2.75C2.34 7.55 2 7.89 2 8.3C2 8.72 2.34 9.05 2.75 9.05H4V11.25H2.75C2.34 11.25 2 11.58 2 12C2 12.41 2.34 12.75 2.75 12.75H4V14.95H2.75C2.34 14.95 2 15.28 2 15.7C2 16.11 2.34 16.45 2.75 16.45H4.23C4.7 18.04 5.96 19.29 7.56 19.77V21.25C7.56 21.66 7.89 22 8.31 22C8.72 22 9.06 21.66 9.06 21.25V20H11.26V21.25C11.26 21.66 11.59 22 12.01 22C12.42 22 12.76 21.66 12.76 21.25V20H14.95V21.25C14.95 21.66 15.29 22 15.7 22C16.11 22 16.45 21.66 16.45 21.25V19.77C18.04 19.29 19.29 18.04 19.77 16.45H21.25C21.67 16.45 22 16.11 22 15.7C22 15.28 21.67 14.95 21.25 14.95H20V12.75H21.25ZM17.26 14.26C17.26 15.91 15.91 17.26 14.26 17.26H9.74C8.09 17.26 6.74 15.91 6.74 14.26V9.74C6.74 8.09 8.09 6.74 9.74 6.74H14.26C15.91 6.74 17.26 8.09 17.26 9.74V14.26Z\' />\n</g>\n\n<g id=\'icon_input\'>\n  <path d=\'M3 6L6 6L6 12L10 12L10 6L13 6V5L8 0L3 5L3 6Z\' />\n  <path d=\'M2 16L14 16V14L2 14V16Z\' />\n</g>\n\n<g id=\'icon_output\'>\n  <path d=\'M13 9H10V16H6V9L3 9V8L8 3L13 8V9Z\' />\n  <path d=\'M14 2H2V0H14V2Z\' />\n</g>\n\n</defs>\n<rect x=\'0\' y=\'27\' width=\'298\' height=\'50\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'301\' y=\'27\' width=\'64\' height=\'50\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'395\' y=\'27\' width=\'200\' height=\'50\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'368\' y=\'27\' width=\'24\' height=\'50\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'598\' y=\'27\' width=\'682\' height=\'50\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<circle cx=\'8\' cy=\'52\' r=\'7\' stroke=\'var(--stage-main, #F2F2F2)\' stroke-width=\'1\' fill=\'var(--stage-clone, #D9D9D9)\' />\n<text text-anchor=\'middle\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'8\' y=\'56\'>1</text>\n<g><title>Memory 0%, 1.00MB</title>\n<use href=\'#icon_memory\' transform=\'translate(395 29) scale(0.6 0.6)\' fill=\'var(--mem-medium, #7E4E5B)\'/>\n  <rect x=\'413\' y=\'29\' width=\'0\' height=\'14\' stroke-width=\'0\' fill=\'var(--mem-light, #AA7785)\'/>  <polygon points=\'413,29 413,29 413,29 413,43 413,43\' stroke=\'none\' fill=\'var(--mem-medium, #7E4E5B)\'/>\n<rect x=\'413\' y=\'32\' width=\'33\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'413\' y=\'40\'>1.00MB</text>\n</g>\n<g><title>CPU Usage 54%, 304us</title>\n<use href=\'#icon_cpu\' transform=\'translate(395 45) scale(0.6 0.6)\' fill=\'var(--cpu-medium, #A36D7B)\'/>\n  <rect x=\'413\' y=\'45\' width=\'180\' height=\'14\' stroke-width=\'0\' fill=\'var(--cpu-light, #B78C98)\'/>  <polygon points=\'413,45 503,45 593,45 593,59 413,59\' stroke=\'none\' fill=\'var(--cpu-medium, #A36D7B)\'/>\n<rect x=\'413\' y=\'48\' width=\'28\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'413\' y=\'56\'>304us</text>\n</g>\n<g><title>Input 100%, 41B, Rows 100%, 2, Width 20B</title>\n<use href=\'#icon_input\' transform=\'translate(395 61) scale(0.9 0.9)\' fill=\'var(--input-medium, #5A8183)\'/>\n  <rect x=\'413\' y=\'61\' width=\'180\' height=\'14\' stroke-width=\'0\' fill=\'var(--input-light, #7CA3A5)\'/>  <polygon points=\'413,61 503,61 593,61 593,75 413,75\' stroke=\'none\' fill=\'var(--input-medium, #5A8183)\'/>\n<rect x=\'413\' y=\'64\' width=\'16\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'413\' y=\'72\'>41B</text>\n</g>\n<g><title>Input, Duration: 0.00 (0.00 | 0.00 | 0.00 - 0.00 | 0.00 | 0.00)</title><rect x=\'601\' y=\'61\' width=\'0\' height=\'14\' stroke-width=\'0\' fill=\'var(--input-medium, #5A8183)\'/>\n</g>\n<rect x=\'0\' y=\'80\' width=\'298\' height=\'66\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'301\' y=\'80\' width=\'64\' height=\'66\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'395\' y=\'80\' width=\'200\' height=\'66\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'368\' y=\'80\' width=\'24\' height=\'66\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<rect x=\'598\' y=\'80\' width=\'682\' height=\'66\' stroke-width=\'0\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<circle cx=\'8\' cy=\'113\' r=\'7\' stroke=\'var(--stage-main, #F2F2F2)\' stroke-width=\'1\' fill=\'var(--stage-clone, #D9D9D9)\' />\n<text text-anchor=\'middle\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'8\' y=\'117\'>0</text>\n<g><title>Output Rows 50%, 2</title>\n  <rect x=\'303\' y=\'86\' width=\'60\' height=\'14\' stroke-width=\'0\' fill=\'var(--output-light, #6F93C3)\'/>  <polygon points=\'303,86 333,86 363,86 363,100 303,100\' stroke=\'none\' fill=\'var(--output-medium, #5781B9)\'/>\n<rect x=\'303\' y=\'89\' width=\'5\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'303\' y=\'97\'>2</text>\n</g>\n<g><title>Output Rows 50%, 2, Est: 88 Rows: 0 Size: 39B</title>\n  <rect x=\'303\' y=\'106\' width=\'60\' height=\'14\' stroke-width=\'0\' fill=\'var(--output-light, #6F93C3)\'/>  <polygon points=\'303,106 333,106 363,106 363,120 303,120\' stroke=\'none\' fill=\'var(--output-medium, #5781B9)\'/>\n<rect x=\'303\' y=\'109\' width=\'5\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'303\' y=\'117\'>2</text>\n</g>\n<g><title>Output 100%, 41B, Rows 100%, 2</title>\n<use href=\'#icon_output\' transform=\'translate(395 82) scale(0.9 0.9)\' fill=\'var(--output-medium, #5781B9)\'/>\n  <rect x=\'413\' y=\'82\' width=\'180\' height=\'14\' stroke-width=\'0\' fill=\'var(--output-light, #6F93C3)\'/>  <polygon points=\'413,82 503,82 593,82 593,96 413,96\' stroke=\'none\' fill=\'var(--output-medium, #5781B9)\'/>\n<rect x=\'413\' y=\'85\' width=\'16\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'413\' y=\'93\'>41B</text>\n</g>\n<g><title>Output, Duration: 0.00 (0.00 | 0.00 | 0.00 - 0.00 | 0.00 | 0.00)</title><rect x=\'601\' y=\'82\' width=\'0\' height=\'14\' stroke-width=\'0\' fill=\'var(--output-medium, #5781B9)\'/>\n</g>\n<g><title>Memory 99%, 201.00MB</title>\n<use href=\'#icon_memory\' transform=\'translate(395 98) scale(0.6 0.6)\' fill=\'var(--mem-medium, #7E4E5B)\'/>\n  <rect x=\'413\' y=\'98\' width=\'180\' height=\'14\' stroke-width=\'0\' fill=\'var(--mem-light, #AA7785)\'/>  <polygon points=\'413,98 503,98 593,98 593,112 413,112\' stroke=\'none\' fill=\'var(--mem-medium, #7E4E5B)\'/>\n<rect x=\'413\' y=\'101\' width=\'44\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'413\' y=\'109\'>201.00MB</text>\n</g>\n<g><title>CPU Usage 45%, 252us</title>\n<use href=\'#icon_cpu\' transform=\'translate(395 114) scale(0.6 0.6)\' fill=\'var(--cpu-medium, #A36D7B)\'/>\n  <rect x=\'413\' y=\'114\' width=\'149\' height=\'14\' stroke-width=\'0\' fill=\'var(--cpu-light, #B78C98)\'/>  <polygon points=\'413,114 487,114 562,114 562,128 413,128\' stroke=\'none\' fill=\'var(--cpu-medium, #A36D7B)\'/>\n<rect x=\'413\' y=\'117\' width=\'28\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'413\' y=\'125\'>252us</text>\n</g>\n<g><title>Ingress 100%, 88B, Rows 100%, 2, Width 44B</title>\n<use href=\'#icon_input\' transform=\'translate(395 130) scale(0.9 0.9)\' fill=\'var(--ingress-medium, #466364)\'/>\n  <rect x=\'413\' y=\'130\' width=\'180\' height=\'14\' stroke-width=\'0\' fill=\'var(--ingress-light, #5A8183)\'/>  <polygon points=\'413,130 503,130 593,130 593,144 413,144\' stroke=\'none\' fill=\'var(--ingress-medium, #466364)\'/>\n<rect x=\'413\' y=\'133\' width=\'16\' height=\'9\' stroke-width=\'0\' opacity=\'0.5\' fill=\'var(--stage-main, #F2F2F2)\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-summary, #262626)\' x=\'413\' y=\'141\'>88B</text>\n</g>\n<g><title>Ingress, Duration: 0.00 (0.00 | 0.00 | 0.00 - 0.00 | 0.00 | 0.00)</title><rect x=\'601\' y=\'130\' width=\'0\' height=\'14\' stroke-width=\'0\' fill=\'var(--ingress-medium, #466364)\'/>\n</g>\n\n<line x1=\'600\' y1=\'0\' x2=\'600\' y2=\'146\' stroke-width=\'1\' stroke=\'var(--stage-grid, #B2B2B2)\' stroke-dasharray=\'1,2\'/>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'602\' y=\'11\'>0:00</text>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'0\' y=\'11\'>Sink</text>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'303\' y=\'11\'>Operators</text>\n<text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'397\' y=\'11\'>Stages</text>\n<text text-anchor=\'end\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'390\' y=\'11\'>Tasks</text>\n<text text-anchor=\'end\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'390\' y=\'22\'>2</text>\n<g><title>Ingress 88B, Rows 2, Width 44B, Avg 88B/s</title>\n  <rect x=\'395\' y=\'14\' width=\'65\' height=\'10\' stroke-width=\'0\' fill=\'var(--ingress-medium, #466364)\'/>\n  <text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-light, #FFFFFF)\' x=\'397\' y=\'22\'>88B</text>\n</g>\n<g><title>CPU Usage 556us, Avg 0.00 CPU/s</title>\n  <rect x=\'462\' y=\'14\' width=\'66\' height=\'10\' stroke-width=\'0\' fill=\'var(--cpu-medium, #A36D7B)\'/>\n  <text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-light, #FFFFFF)\' x=\'464\' y=\'22\'>556us</text>\n</g>\n<g><title>Memory 202.00MB</title>\n  <rect x=\'530\' y=\'14\' width=\'65\' height=\'10\' stroke-width=\'0\' fill=\'var(--mem-medium, #7E4E5B)\'/>\n  <text font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-light, #FFFFFF)\' x=\'532\' y=\'22\'>202.00MB</text>\n</g>\n<g><title>Duration: 1.00, Total 1.00</title>\n  <rect x=\'1215\' y=\'3\' width=\'65\' height=\'10\' stroke-width=\'0\' fill=\'var(--stage-grid, #B2B2B2)\'/>\n  <text text-anchor=\'end\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--text-inv, #FFFFFF)\' x=\'1278\' y=\'11\'>1.00</text>\n</g>\n<g><title>Max CPU 0.48</title>\n<polygon points=\'598,26 598,26 598,26 598,26 598,26 598,26 598,26 598,26 599,26 599,26 599,26 600,26 600,26 600,26 600,26 600,26 600,13 601,24 601,26 601,26 601,26 602,26 602,26 602,26 602,26 602,26 602,26 603,26 603,26 603,26 604,26 604,26 604,20 604,26 604,26 \' stroke-width=\'1\' stroke=\'var(--cpu-medium, #A36D7B)\' fill=\'var(--cpu-light, #B78C98)\' />\n</g>\n<g><title>Stage: </title>  <text clip-path=\'url(#clipTextPath)\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'18\' y=\'38\'>Stage</text>  <text clip-path=\'url(#clipTextPath)\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'22\' y=\'48\'></text></g>\n<g><title>Stage 1, tasks: 1, finished: 1</title>\n<line x1=\'371\' y1=\'27\' x2=\'371\' y2=\'77\' stroke-width=\'6\' stroke=\'var(--stage-text, #262626)\' stroke-dasharray=\'1,1\' />\n  <text text-anchor=\'end\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'390\' y=\'56\'>1</text>\n</g>\n<g><title>Max MEM 1.00MB</title>\n<polygon points=\'598,42 598,29 604,29 604,42 \' stroke-width=\'1\' stroke=\'var(--mem-medium, #7E4E5B)\' fill=\'var(--mem-medium, #7E4E5B)\' />\n</g>\n<g><title>Max CPU 0.30</title>\n<polygon points=\'598,58 598,58 598,58 598,58 598,58 598,58 598,58 598,58 599,58 599,58 599,58 600,58 600,58 600,58 600,58 600,58 600,58 601,58 601,58 601,58 601,58 602,58 602,58 602,58 602,58 602,58 602,58 603,58 603,58 603,58 604,58 604,58 604,45 604,58 604,58 \' stroke-width=\'1\' stroke=\'var(--cpu-medium, #A36D7B)\' fill=\'var(--cpu-light, #B78C98)\' />\n</g>\n<g><title>Connection: Map</title>\n  <polygon points=\'16,94 0,94 0,80 8,76 16,80\' stroke-width=\'1\' stroke=\'var(--conn-line, #BFBFBF)\' fill=\'var(--conn-fill, #BFBFBF)\'/>\n  <text text-anchor=\'middle\' font-family=\'Verdana\' font-size=\'6px\' fill=\'var(--conn-text, #393939)\' x=\'8\' y=\'90\'>Ma</text>\n</g>\n<g><title>Stage: </title>  <text clip-path=\'url(#clipTextPath)\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'18\' y=\'91\'>Stage</text>  <text clip-path=\'url(#clipTextPath)\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'22\' y=\'101\'></text></g>\n<line x1=\'18\' y1=\'103\' x2=\'298\' y2=\'103\' stroke-width=\'1\' stroke=\'var(--stage-grid, #B2B2B2)\' stroke-dasharray=\'1,2\'/>\n<g><title>Source s3: h5899168521978938860_test_timestamp_simple_posix_insertmy_binding(Fruit, Price, Time, Weight)</title>  <text clip-path=\'url(#clipTextPath)\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'18\' y=\'111\'>Source s3</text>  <text clip-path=\'url(#clipTextPath)\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'22\' y=\'121\'>h5899168521978938860_test_timestamp_simple_posix_insertmy_binding(Fruit, Price, Time, Weight)</text></g>\n<g><title>Stage 0, tasks: 1, finished: 1</title>\n<line x1=\'371\' y1=\'80\' x2=\'371\' y2=\'146\' stroke-width=\'6\' stroke=\'var(--stage-text, #262626)\' stroke-dasharray=\'1,1\' />\n  <text text-anchor=\'end\' font-family=\'Verdana\' font-size=\'8px\' fill=\'var(--stage-text, #262626)\' x=\'390\' y=\'117\'>1</text>\n</g>\n<g><title>Max MEM 201.00MB</title>\n<polygon points=\'598,111 598,111 601,98 601,111 \' stroke-width=\'1\' stroke=\'var(--mem-medium, #7E4E5B)\' fill=\'var(--mem-medium, #7E4E5B)\' />\n</g>\n<g><title>Max CPU 0.97</title>\n<polygon points=\'598,127 598,127 598,127 598,127 598,127 598,127 598,127 598,127 598,127 598,127 598,127 598,127 598,127 598,127 599,127 599,127 599,127 599,127 599,127 599,127 599,127 600,127 600,127 600,127 600,127 600,127 600,127 600,127 600,127 600,127 600,127 600,127 600,114 601,125 601,127 \' stroke-width=\'1\' stroke=\'var(--cpu-medium, #A36D7B)\' fill=\'var(--cpu-light, #B78C98)\' />\n</g>\n\n</svg>\n"
  }
}

2025-12-12 13:26:18,104 - DEBUG - botocore.hooks - _emit: Event choose-service-name: calling handler <function handle_service_name_alias at 0x7f3738f31010>
2025-12-12 13:26:18,110 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function add_generate_presigned_post at 0x7f373903cd10>
2025-12-12 13:26:18,111 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function lazy_call.<locals>._handler at 0x7f3737981610>
2025-12-12 13:26:18,111 - DEBUG - botocore.hooks - _emit: Event creating-client-class.s3: calling handler <function add_generate_presigned_url at 0x7f373903ca10>
2025-12-12 13:26:18,118 - DEBUG - botocore.endpoint - create_endpoint: Setting s3 timeout as (60, 60)
2025-12-12 13:26:18,127 - DEBUG - botocore.client - _register_legacy_retries: Registering retry handlers for service: s3
2025-12-12 13:26:18,128 - DEBUG - botocore.utils - register: Registering S3 region redirector handler
2025-12-12 13:26:18,130 - DEBUG - boto3.resources.factory - load_from_definition: Loading s3:s3
2025-12-12 13:26:18,134 - DEBUG - boto3.resources.factory - load_from_definition: Loading s3:Bucket
2025-12-12 13:26:18,135 - DEBUG - boto3.resources.model - _load_name_with_category: Renaming Bucket attribute name
2025-12-12 13:26:18,137 - DEBUG - botocore.hooks - _emit: Event creating-resource-class.s3.Bucket: calling handler <function lazy_call.<locals>._handler at 0x7f3737982090>
2025-12-12 13:26:18,137 - DEBUG - boto3.resources.collection - pages: Calling paginated s3:list_objects with {'Bucket': 'fbucket'}
2025-12-12 13:26:18,139 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function set_list_objects_encoding_type_url at 0x7f3738f587d0>
2025-12-12 13:26:18,140 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function validate_bucket_name at 0x7f3738f32ed0>
2025-12-12 13:26:18,140 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function remove_bucket_from_url_paths_from_model at 0x7f3738f59790>
2025-12-12 13:26:18,140 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <bound method S3RegionRedirectorv2.annotate_request_context of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,143 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.ListObjects: calling handler <function generate_idempotent_uuid at 0x7f3738f32c90>
2025-12-12 13:26:18,147 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <function customize_endpoint_resolver_builtins at 0x7f3738f599d0>
2025-12-12 13:26:18,148 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <bound method S3RegionRedirectorv2.redirect_from_cache of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,148 - DEBUG - botocore.regions - construct_endpoint: Calling endpoint provider with parameters: {'Bucket': 'fbucket', 'Region': 'yandex', 'UseFIPS': False, 'UseDualStack': False, 'Endpoint': 'http://localhost:24309', 'ForcePathStyle': True, 'Accelerate': False, 'UseGlobalEndpoint': False, 'DisableMultiRegionAccessPoints': False, 'UseArnRegion': True}
2025-12-12 13:26:18,150 - DEBUG - botocore.regions - construct_endpoint: Endpoint provider result: http://localhost:24309/fbucket
2025-12-12 13:26:18,150 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selecting from endpoint provider's list of auth schemes: "sigv4". User selected auth scheme is: "None"
2025-12-12 13:26:18,150 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selected auth type "v4" as "v4" with signing context params: {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}
2025-12-12 13:26:18,154 - DEBUG - botocore.hooks - _emit: Event before-call.s3.ListObjects: calling handler <function add_expect_header at 0x7f3738f33350>
2025-12-12 13:26:18,155 - DEBUG - botocore.hooks - _emit: Event before-call.s3.ListObjects: calling handler <function add_recursion_detection_header at 0x7f3738f31250>
2025-12-12 13:26:18,156 - DEBUG - botocore.hooks - _emit: Event before-call.s3.ListObjects: calling handler <function inject_api_version_header_if_needed at 0x7f3738f58dd0>
2025-12-12 13:26:18,157 - DEBUG - botocore.endpoint - make_request: Making request for OperationModel(name=ListObjects) with params: {'url_path': '', 'query_string': {'encoding-type': 'url'}, 'method': 'GET', 'headers': {'User-Agent': 'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource'}, 'body': b'', 'auth_path': '/fbucket/', 'url': 'http://localhost:24309/fbucket?encoding-type=url', 'context': {'client_region': 'yandex', 'client_config': <botocore.config.Config object at 0x7f371b81b940>, 'has_streaming_input': False, 'auth_type': 'v4', 'encoding_type_auto_set': True, 's3_redirect': {'redirected': False, 'bucket': 'fbucket', 'params': {'Bucket': 'fbucket', 'EncodingType': 'url'}}, 'signing': {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}}}
2025-12-12 13:26:18,159 - DEBUG - botocore.hooks - _emit: Event request-created.s3.ListObjects: calling handler <bound method RequestSigner.handler of <botocore.signers.RequestSigner object at 0x7f371b81bd50>>
2025-12-12 13:26:18,159 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.ListObjects: calling handler <bound method ClientCreator._default_s3_presign_to_sigv2 of <botocore.client.ClientCreator object at 0x7f371b9c67c0>>
2025-12-12 13:26:18,160 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.ListObjects: calling handler <function set_operation_specific_signer at 0x7f3738f32b10>
2025-12-12 13:26:18,161 - DEBUG - botocore.hooks - _emit: Event before-sign.s3.ListObjects: calling handler <function remove_arn_from_signing_path at 0x7f3738f59910>
2025-12-12 13:26:18,163 - DEBUG - botocore.auth - add_auth: Calculating signature using v4 auth.
2025-12-12 13:26:18,163 - DEBUG - botocore.auth - add_auth: CanonicalRequest:
GET
/fbucket
encoding-type=url
host:localhost:24309
x-amz-content-sha256:e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date:20251212T132618Z

host;x-amz-content-sha256;x-amz-date
e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
2025-12-12 13:26:18,164 - DEBUG - botocore.auth - add_auth: StringToSign:
AWS4-HMAC-SHA256
20251212T132618Z
20251212/yandex/s3/aws4_request
fd97fc82ae6af8d91aa588cc74ac5944f278a19b84e56cc6a65d48d9d0710d3e
2025-12-12 13:26:18,164 - DEBUG - botocore.auth - add_auth: Signature:
5c73cefd73e6b1e2f28dbf3b3011c29dca4afa376f677e0623ba2309976a3cd5
2025-12-12 13:26:18,165 - DEBUG - botocore.hooks - _emit: Event request-created.s3.ListObjects: calling handler <function add_retry_headers at 0x7f3738f596d0>
2025-12-12 13:26:18,166 - DEBUG - botocore.endpoint - _do_get_response: Sending http request: <AWSPreparedRequest stream_output=False, method=GET, url=http://localhost:24309/fbucket?encoding-type=url, headers={'User-Agent': b'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource', 'X-Amz-Date': b'20251212T132618Z', 'X-Amz-Content-SHA256': b'e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855', 'Authorization': b'AWS4-HMAC-SHA256 Credential=key/20251212/yandex/s3/aws4_request, SignedHeaders=host;x-amz-content-sha256;x-amz-date, Signature=5c73cefd73e6b1e2f28dbf3b3011c29dca4afa376f677e0623ba2309976a3cd5', 'amz-sdk-invocation-id': b'5a92e982-1ccc-403e-bfe5-d1ce684c6547', 'amz-sdk-request': b'attempt=1'}>
2025-12-12 13:26:18,175 - DEBUG - botocore.parsers - parse: Response headers: {'Server': 'Werkzeug/2.2.3 Python/3.12.9', 'Date': 'Fri, 12 Dec 2025 13:26:18 GMT', 'x-amzn-requestid': 'oPBD9surpIIxD4JMz3TewN8Eb4BUvPjCcaXQ00GsfAtAlxgRd2O2', 'Content-Type': 'text/html; charset=utf-8', 'Content-Length': '983', 'Access-Control-Allow-Origin': '*', 'Connection': 'close'}
2025-12-12 13:26:18,176 - DEBUG - botocore.parsers - parse: Response body:
b'<?xml version="1.0" encoding="UTF-8"?><ListBucketResult xmlns="http://s3.amazonaws.com/doc/2006-03-01/"><Name>fbucket</Name><MaxKeys>1000</MaxKeys><EncodingType>url</EncodingType><IsTruncated>false</IsTruncated><Contents><Key>common/simple_posix/test.tsv</Key><LastModified>2025-12-12T13:26:17.000Z</LastModified><ETag>&#34;bdda80fc5ac96e1e2bd99c3ad76524a2&#34;</ETag><Size>88</Size><StorageClass>STANDARD</StorageClass><Owner><ID>75aa57f09aa0c8caeab4f8c24e99d10f8e7faeebf76c078efc7c6caea54ba06a</ID><DisplayName>webfile</DisplayName></Owner></Contents><Contents><Key>timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv</Key><LastModified>2025-12-12T13:26:17.000Z</LastModified><ETag>&#34;d52d445a799e169545f81aac31e63b23&#34;</ETag><Size>88</Size><StorageClass>STANDARD</StorageClass><Owner><ID>75aa57f09aa0c8caeab4f8c24e99d10f8e7faeebf76c078efc7c6caea54ba06a</ID><DisplayName>webfile</DisplayName></Owner></Contents></ListBucketResult>'
2025-12-12 13:26:18,179 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.ListObjects: calling handler <botocore.retryhandler.RetryHandler object at 0x7f371b01c650>
2025-12-12 13:26:18,180 - DEBUG - botocore.retryhandler - __call__: No retry needed.
2025-12-12 13:26:18,181 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.ListObjects: calling handler <bound method S3RegionRedirectorv2.redirect_from_error of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,181 - DEBUG - botocore.hooks - _emit: Event after-call.s3.ListObjects: calling handler <function decode_list_object at 0x7f3738f58890>
2025-12-12 13:26:18,188 - DEBUG - boto3.resources.factory - load_from_definition: Loading s3:ObjectSummary
2025-12-12 13:26:18,192 - DEBUG - boto3.resources.model - _load_name_with_category: Renaming ObjectSummary attribute key
2025-12-12 13:26:18,194 - DEBUG - botocore.hooks - _emit: Event creating-resource-class.s3.ObjectSummary: calling handler <function lazy_call.<locals>._handler at 0x7f3737982210>
2025-12-12 13:26:18,195 - DEBUG - s3transfer.utils - acquire: Acquiring 0
2025-12-12 13:26:18,195 - DEBUG - s3transfer.tasks - _wait_until_all_complete: DownloadSubmissionTask(transfer_id=0, {'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f371b1a11e0>}) about to wait for the following futures []
2025-12-12 13:26:18,196 - DEBUG - s3transfer.tasks - _wait_until_all_complete: DownloadSubmissionTask(transfer_id=0, {'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f371b1a11e0>}) done waiting for dependent futures
2025-12-12 13:26:18,197 - DEBUG - s3transfer.tasks - _execute_main: Executing task DownloadSubmissionTask(transfer_id=0, {'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f371b1a11e0>}) with kwargs {'client': <botocore.client.S3 object at 0x7f371ae47030>, 'config': <boto3.s3.transfer.TransferConfig object at 0x7f371ae2e810>, 'osutil': <s3transfer.utils.OSUtils object at 0x7f371ae2dd70>, 'request_executor': <s3transfer.futures.BoundedExecutor object at 0x7f371b1a0650>, 'transfer_future': <s3transfer.futures.TransferFuture object at 0x7f371b1a11e0>, 'io_executor': <s3transfer.futures.BoundedExecutor object at 0x7f371b1a2e50>}
2025-12-12 13:26:18,197 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.HeadObject: calling handler <function sse_md5 at 0x7f3738f32f90>
2025-12-12 13:26:18,198 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.HeadObject: calling handler <function validate_bucket_name at 0x7f3738f32ed0>
2025-12-12 13:26:18,200 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.HeadObject: calling handler <function remove_bucket_from_url_paths_from_model at 0x7f3738f59790>
2025-12-12 13:26:18,200 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.HeadObject: calling handler <bound method S3RegionRedirectorv2.annotate_request_context of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,200 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.HeadObject: calling handler <function generate_idempotent_uuid at 0x7f3738f32c90>
2025-12-12 13:26:18,201 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <function customize_endpoint_resolver_builtins at 0x7f3738f599d0>
2025-12-12 13:26:18,201 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <bound method S3RegionRedirectorv2.redirect_from_cache of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,201 - DEBUG - botocore.regions - construct_endpoint: Calling endpoint provider with parameters: {'Bucket': 'fbucket', 'Region': 'yandex', 'UseFIPS': False, 'UseDualStack': False, 'Endpoint': 'http://localhost:24309', 'ForcePathStyle': True, 'Accelerate': False, 'UseGlobalEndpoint': False, 'DisableMultiRegionAccessPoints': False, 'UseArnRegion': True}
2025-12-12 13:26:18,201 - DEBUG - botocore.regions - construct_endpoint: Endpoint provider result: http://localhost:24309/fbucket
2025-12-12 13:26:18,201 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selecting from endpoint provider's list of auth schemes: "sigv4". User selected auth scheme is: "None"
2025-12-12 13:26:18,202 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selected auth type "v4" as "v4" with signing context params: {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}
2025-12-12 13:26:18,203 - DEBUG - botocore.hooks - _emit: Event before-call.s3.HeadObject: calling handler <function add_expect_header at 0x7f3738f33350>
2025-12-12 13:26:18,203 - DEBUG - botocore.hooks - _emit: Event before-call.s3.HeadObject: calling handler <function add_recursion_detection_header at 0x7f3738f31250>
2025-12-12 13:26:18,204 - DEBUG - botocore.hooks - _emit: Event before-call.s3.HeadObject: calling handler <function inject_api_version_header_if_needed at 0x7f3738f58dd0>
2025-12-12 13:26:18,204 - DEBUG - botocore.endpoint - make_request: Making request for OperationModel(name=HeadObject) with params: {'url_path': '/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'query_string': {}, 'method': 'HEAD', 'headers': {'User-Agent': 'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource'}, 'body': b'', 'auth_path': '/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'url': 'http://localhost:24309/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'context': {'client_region': 'yandex', 'client_config': <botocore.config.Config object at 0x7f371b81b940>, 'has_streaming_input': False, 'auth_type': 'v4', 's3_redirect': {'redirected': False, 'bucket': 'fbucket', 'params': {'Bucket': 'fbucket', 'Key': 'timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv'}}, 'signing': {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}}}
2025-12-12 13:26:18,207 - DEBUG - botocore.hooks - _emit: Event request-created.s3.HeadObject: calling handler <function signal_not_transferring at 0x7f3738219790>
2025-12-12 13:26:18,208 - DEBUG - botocore.hooks - _emit: Event request-created.s3.HeadObject: calling handler <bound method RequestSigner.handler of <botocore.signers.RequestSigner object at 0x7f371b81bd50>>
2025-12-12 13:26:18,210 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.HeadObject: calling handler <bound method ClientCreator._default_s3_presign_to_sigv2 of <botocore.client.ClientCreator object at 0x7f371b9c67c0>>
2025-12-12 13:26:18,210 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.HeadObject: calling handler <function set_operation_specific_signer at 0x7f3738f32b10>
2025-12-12 13:26:18,212 - DEBUG - botocore.hooks - _emit: Event before-sign.s3.HeadObject: calling handler <function remove_arn_from_signing_path at 0x7f3738f59910>
2025-12-12 13:26:18,213 - DEBUG - botocore.auth - add_auth: Calculating signature using v4 auth.
2025-12-12 13:26:18,213 - DEBUG - botocore.auth - add_auth: CanonicalRequest:
HEAD
/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv

host:localhost:24309
x-amz-content-sha256:e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date:20251212T132618Z

host;x-amz-content-sha256;x-amz-date
e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
2025-12-12 13:26:18,214 - DEBUG - botocore.auth - add_auth: StringToSign:
AWS4-HMAC-SHA256
20251212T132618Z
20251212/yandex/s3/aws4_request
251e3c2eb1107d75c1cb22ca4e5358a3e170fb3179fd4ecc39368c93096a275a
2025-12-12 13:26:18,214 - DEBUG - botocore.auth - add_auth: Signature:
0ed4c91fc43adba614722e1d330aabd2dbec5a2504a1a18fbce539025739ae98
2025-12-12 13:26:18,215 - DEBUG - botocore.hooks - _emit: Event request-created.s3.HeadObject: calling handler <function signal_transferring at 0x7f3738219850>
2025-12-12 13:26:18,216 - DEBUG - botocore.hooks - _emit: Event request-created.s3.HeadObject: calling handler <function add_retry_headers at 0x7f3738f596d0>
2025-12-12 13:26:18,217 - DEBUG - botocore.endpoint - _do_get_response: Sending http request: <AWSPreparedRequest stream_output=False, method=HEAD, url=http://localhost:24309/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv, headers={'User-Agent': b'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource', 'X-Amz-Date': b'20251212T132618Z', 'X-Amz-Content-SHA256': b'e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855', 'Authorization': b'AWS4-HMAC-SHA256 Credential=key/20251212/yandex/s3/aws4_request, SignedHeaders=host;x-amz-content-sha256;x-amz-date, Signature=0ed4c91fc43adba614722e1d330aabd2dbec5a2504a1a18fbce539025739ae98', 'amz-sdk-invocation-id': b'8da1ce6a-bf70-496f-8f30-38a341cae191', 'amz-sdk-request': b'attempt=1'}>
2025-12-12 13:26:18,224 - DEBUG - botocore.parsers - parse: Response headers: {'Server': 'Werkzeug/2.2.3 Python/3.12.9', 'Date': 'Fri, 12 Dec 2025 13:26:18 GMT', 'content-type': 'binary/octet-stream', 'ETag': '"d52d445a799e169545f81aac31e63b23"', 'last-modified': 'Fri, 12 Dec 2025 13:26:17 GMT', 'Content-Length': '88', 'x-amzn-requestid': '9324f6lITCD1E6KP28NLAkFO3KeYma7SoAVnJr9gle8nKphdV00k', 'Access-Control-Allow-Origin': '*', 'Connection': 'close'}
2025-12-12 13:26:18,226 - DEBUG - botocore.parsers - parse: Response body:
b''
2025-12-12 13:26:18,228 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.HeadObject: calling handler <botocore.retryhandler.RetryHandler object at 0x7f371b01c650>
2025-12-12 13:26:18,228 - DEBUG - botocore.retryhandler - __call__: No retry needed.
2025-12-12 13:26:18,229 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.HeadObject: calling handler <bound method S3RegionRedirectorv2.redirect_from_error of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,229 - DEBUG - s3transfer.futures - submit: Submitting task ImmediatelyWriteIOGetObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'extra_args': {}}) to executor <s3transfer.futures.BoundedExecutor object at 0x7f371b1a0650> for transfer request: 0.
2025-12-12 13:26:18,229 - DEBUG - s3transfer.utils - acquire: Acquiring 0
2025-12-12 13:26:18,230 - DEBUG - s3transfer.tasks - _wait_until_all_complete: ImmediatelyWriteIOGetObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'extra_args': {}}) about to wait for the following futures []
2025-12-12 13:26:18,230 - DEBUG - s3transfer.utils - release: Releasing acquire 0/None
2025-12-12 13:26:18,231 - DEBUG - s3transfer.tasks - _wait_until_all_complete: ImmediatelyWriteIOGetObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'extra_args': {}}) done waiting for dependent futures
2025-12-12 13:26:18,232 - DEBUG - s3transfer.tasks - _execute_main: Executing task ImmediatelyWriteIOGetObjectTask(transfer_id=0, {'bucket': 'fbucket', 'key': 'timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'extra_args': {}}) with kwargs {'client': <botocore.client.S3 object at 0x7f371ae47030>, 'bucket': 'fbucket', 'key': 'timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'fileobj': <_io.BytesIO object at 0x7f371b894d00>, 'extra_args': {}, 'callbacks': [], 'max_attempts': 5, 'download_output_manager': <s3transfer.download.DownloadSeekableOutputManager object at 0x7f37382f0e20>, 'io_chunksize': 262144, 'bandwidth_limiter': None}
2025-12-12 13:26:18,233 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.GetObject: calling handler <function sse_md5 at 0x7f3738f32f90>
2025-12-12 13:26:18,233 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.GetObject: calling handler <function validate_bucket_name at 0x7f3738f32ed0>
2025-12-12 13:26:18,233 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.GetObject: calling handler <function remove_bucket_from_url_paths_from_model at 0x7f3738f59790>
2025-12-12 13:26:18,233 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.GetObject: calling handler <bound method S3RegionRedirectorv2.annotate_request_context of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,233 - DEBUG - botocore.hooks - _emit: Event before-parameter-build.s3.GetObject: calling handler <function generate_idempotent_uuid at 0x7f3738f32c90>
2025-12-12 13:26:18,234 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <function customize_endpoint_resolver_builtins at 0x7f3738f599d0>
2025-12-12 13:26:18,234 - DEBUG - botocore.hooks - _emit: Event before-endpoint-resolution.s3: calling handler <bound method S3RegionRedirectorv2.redirect_from_cache of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,235 - DEBUG - botocore.regions - construct_endpoint: Calling endpoint provider with parameters: {'Bucket': 'fbucket', 'Region': 'yandex', 'UseFIPS': False, 'UseDualStack': False, 'Endpoint': 'http://localhost:24309', 'ForcePathStyle': True, 'Accelerate': False, 'UseGlobalEndpoint': False, 'DisableMultiRegionAccessPoints': False, 'UseArnRegion': True}
2025-12-12 13:26:18,235 - DEBUG - botocore.regions - construct_endpoint: Endpoint provider result: http://localhost:24309/fbucket
2025-12-12 13:26:18,235 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selecting from endpoint provider's list of auth schemes: "sigv4". User selected auth scheme is: "None"
2025-12-12 13:26:18,235 - DEBUG - botocore.regions - auth_schemes_to_signing_ctx: Selected auth type "v4" as "v4" with signing context params: {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}
2025-12-12 13:26:18,236 - DEBUG - botocore.hooks - _emit: Event before-call.s3.GetObject: calling handler <function add_expect_header at 0x7f3738f33350>
2025-12-12 13:26:18,236 - DEBUG - botocore.hooks - _emit: Event before-call.s3.GetObject: calling handler <function add_recursion_detection_header at 0x7f3738f31250>
2025-12-12 13:26:18,237 - DEBUG - botocore.hooks - _emit: Event before-call.s3.GetObject: calling handler <function inject_api_version_header_if_needed at 0x7f3738f58dd0>
2025-12-12 13:26:18,237 - DEBUG - botocore.endpoint - make_request: Making request for OperationModel(name=GetObject) with params: {'url_path': '/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'query_string': {}, 'method': 'GET', 'headers': {'User-Agent': 'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource'}, 'body': b'', 'auth_path': '/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'url': 'http://localhost:24309/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv', 'context': {'client_region': 'yandex', 'client_config': <botocore.config.Config object at 0x7f371b81b940>, 'has_streaming_input': False, 'auth_type': 'v4', 's3_redirect': {'redirected': False, 'bucket': 'fbucket', 'params': {'Bucket': 'fbucket', 'Key': 'timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv'}}, 'signing': {'region': 'yandex', 'signing_name': 's3', 'disableDoubleEncoding': True}}}
2025-12-12 13:26:18,238 - DEBUG - botocore.hooks - _emit: Event request-created.s3.GetObject: calling handler <function signal_not_transferring at 0x7f3738219790>
2025-12-12 13:26:18,238 - DEBUG - botocore.hooks - _emit: Event request-created.s3.GetObject: calling handler <bound method RequestSigner.handler of <botocore.signers.RequestSigner object at 0x7f371b81bd50>>
2025-12-12 13:26:18,239 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.GetObject: calling handler <bound method ClientCreator._default_s3_presign_to_sigv2 of <botocore.client.ClientCreator object at 0x7f371b9c67c0>>
2025-12-12 13:26:18,239 - DEBUG - botocore.hooks - _emit: Event choose-signer.s3.GetObject: calling handler <function set_operation_specific_signer at 0x7f3738f32b10>
2025-12-12 13:26:18,239 - DEBUG - botocore.hooks - _emit: Event before-sign.s3.GetObject: calling handler <function remove_arn_from_signing_path at 0x7f3738f59910>
2025-12-12 13:26:18,240 - DEBUG - botocore.auth - add_auth: Calculating signature using v4 auth.
2025-12-12 13:26:18,240 - DEBUG - botocore.auth - add_auth: CanonicalRequest:
GET
/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv

host:localhost:24309
x-amz-content-sha256:e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
x-amz-date:20251212T132618Z

host;x-amz-content-sha256;x-amz-date
e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855
2025-12-12 13:26:18,240 - DEBUG - botocore.auth - add_auth: StringToSign:
AWS4-HMAC-SHA256
20251212T132618Z
20251212/yandex/s3/aws4_request
34f56e0036921c50d0d7dc75ebac4bed3b593cd0c768ff323fa41a8b1e47cfc1
2025-12-12 13:26:18,240 - DEBUG - botocore.auth - add_auth: Signature:
38831d01a4df2e5bd9e579b9199accb708da7d80d9dd26c3612096dadcb00dd1
2025-12-12 13:26:18,241 - DEBUG - botocore.hooks - _emit: Event request-created.s3.GetObject: calling handler <function signal_transferring at 0x7f3738219850>
2025-12-12 13:26:18,241 - DEBUG - botocore.hooks - _emit: Event request-created.s3.GetObject: calling handler <function add_retry_headers at 0x7f3738f596d0>
2025-12-12 13:26:18,241 - DEBUG - botocore.endpoint - _do_get_response: Sending http request: <AWSPreparedRequest stream_output=True, method=GET, url=http://localhost:24309/fbucket/timestamp/simple_posix/tsv_with_names/ptjudq7r5iofh4qsuph7_0_EgsWb1gceE6prDqxmxJyBqEkIzA7mO7p.tsv, headers={'User-Agent': b'Boto3/1.29.6 md/Botocore#1.31.80 ua/2.0 os/linux#5.15.0-157-generic md/arch#x86_64 lang/python#3.12.9 md/pyimpl#CPython cfg/retry-mode#legacy Botocore/1.31.80 Resource', 'X-Amz-Date': b'20251212T132618Z', 'X-Amz-Content-SHA256': b'e3b0c44298fc1c149afbf4c8996fb92427ae41e4649b934ca495991b7852b855', 'Authorization': b'AWS4-HMAC-SHA256 Credential=key/20251212/yandex/s3/aws4_request, SignedHeaders=host;x-amz-content-sha256;x-amz-date, Signature=38831d01a4df2e5bd9e579b9199accb708da7d80d9dd26c3612096dadcb00dd1', 'amz-sdk-invocation-id': b'f0c37207-5c68-4ddd-bc6a-2d577a554f9c', 'amz-sdk-request': b'attempt=1'}>
2025-12-12 13:26:18,247 - DEBUG - botocore.parsers - parse: Response headers: {'Server': 'Werkzeug/2.2.3 Python/3.12.9', 'Date': 'Fri, 12 Dec 2025 13:26:18 GMT', 'x-amz-version-id': 'null', 'content-type': 'binary/octet-stream', 'ETag': '"d52d445a799e169545f81aac31e63b23"', 'last-modified': 'Fri, 12 Dec 2025 13:26:17 GMT', 'Content-Length': '88', 'x-amzn-requestid': 'XyOIHxOp9b6oIB51hUv0nyzzNZOgZJGdqej7E1CQmXQizAlZt55X', 'Access-Control-Allow-Origin': '*', 'Connection': 'close'}
2025-12-12 13:26:18,247 - DEBUG - botocore.parsers - parse: Response body:
<botocore.response.StreamingBody object at 0x7f371b087250>
2025-12-12 13:26:18,249 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.GetObject: calling handler <botocore.retryhandler.RetryHandler object at 0x7f371b01c650>
2025-12-12 13:26:18,254 - DEBUG - botocore.retryhandler - __call__: No retry needed.
2025-12-12 13:26:18,255 - DEBUG - botocore.hooks - _emit: Event needs-retry.s3.GetObject: calling handler <bound method S3RegionRedirectorv2.redirect_from_error of <botocore.utils.S3RegionRedirectorv2 object at 0x7f373759bc10>>
2025-12-12 13:26:18,256 - DEBUG - s3transfer.tasks - _wait_until_all_complete: IOWriteTask(transfer_id=0, {'offset': 0}) about to wait for the following futures []
2025-12-12 13:26:18,256 - DEBUG - s3transfer.tasks - _wait_until_all_complete: IOWriteTask(transfer_id=0, {'offset': 0}) done waiting for dependent futures
2025-12-12 13:26:18,256 - DEBUG - s3transfer.tasks - _execute_main: Executing task IOWriteTask(transfer_id=0, {'offset': 0}) with kwargs {'fileobj': <_io.BytesIO object at 0x7f371b894d00>, 'offset': 0}
2025-12-12 13:26:18,258 - DEBUG - s3transfer.tasks - _wait_until_all_complete: CompleteDownloadNOOPTask(transfer_id=0, {}) about to wait for the following futures []
2025-12-12 13:26:18,259 - DEBUG - s3transfer.tasks - _wait_until_all_complete: CompleteDownloadNOOPTask(transfer_id=0, {}) done waiting for dependent futures
2025-12-12 13:26:18,259 - DEBUG - s3transfer.tasks - _execute_main: Executing task CompleteDownloadNOOPTask(transfer_id=0, {}) with kwargs {}
2025-12-12 13:26:18,260 - DEBUG - s3transfer.utils - release: Releasing acquire 0/None
2025-12-12 13:26:18,263 - INFO - ya.test - pytest_runtest_teardown: Test teardown
2025-12-12 13:31:28,141 - DEBUG - ya.test - _verify_test: Verifying [test_format_setting.TestS3.test_timestamp_simple_posix_insert[v2-common/simple_posix/test.tsv-tsv_with_names] in ydb/tests/fq/s3] canonical results
2025-12-12 13:31:28,142 - DEBUG - ya.test - verify: Test test_format_setting.TestS3.test_timestamp_simple_posix_insert[v2-common/simple_posix/test.tsv-tsv_with_names] status: good
