2025-10-25 18:48:08,120 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "file_in_memory_log" initialized in 0.000014 2025-10-25 18:48:08,121 DEBUG (root) [MainThread] Release revision: 15920432 2025-10-25 18:48:08,121 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "revision" initialized in 0.000795 2025-10-25 18:48:08,121 DEBUG (yalibrary.vcs) [MainThread] detecting vcs from /home/runner/actions_runner/_work/ydb/ydb for paths: None 2025-10-25 18:48:08,121 DEBUG (yalibrary.vcs) [MainThread] common root: /home/runner/actions_runner/_work/ydb/ydb 2025-10-25 18:48:08,121 DEBUG (yalibrary.vcs) [MainThread] vcs root: /home/runner/actions_runner/_work/ydb/ydb (git) 2025-10-25 18:48:08,121 DEBUG (root) [MainThread] vcs type: git 2025-10-25 18:48:08,121 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "vcs_type" initialized in 0.000214 2025-10-25 18:48:08,121 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "exit" initialized in 0.000002 2025-10-25 18:48:08,121 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "metrics_reporter" initialized in 0.000025 2025-10-25 18:48:08,122 DEBUG (devtools.ya.core.sec) [MainThread] Found 0 secrets 2025-10-25 18:48:08,122 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "report" initialized in 0.000551 2025-10-25 18:48:08,122 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "exit_code" initialized in 0.000001 2025-10-25 18:48:08,122 DEBUG (root) [MainThread] Start up timestamp 2025-10-25T18:48:08.UTC (2025-10-25T18:48:08.UTC) 2025-10-25 18:48:08,122 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "lifecycle_ts" initialized in 0.000037 2025-10-25 18:48:08,122 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "env_checker" initialized in 0.000005 2025-10-25 18:48:08,122 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetchers_storage" initialized in 0.000400 2025-10-25 18:48:08,123 DEBUG (library.python.tmp) [MainThread] Set TMPDIR=/home/runner/.ya/tmp/1761418088.3025.zi64moov instead of None 2025-10-25 18:48:08,123 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "tmp_dir" initialized in 0.000136 2025-10-25 18:48:08,123 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=modules-initialization-early, group=overall-execution, time=1761418088.123196 2025-10-25 18:48:08,123 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage modules-initialization-early_finished=1761418088.123196 2025-10-25 18:48:08,123 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step modules-initialization-early_finished - 1761418088.123196 2025-10-25 18:48:08,123 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=handler-selection, group=overall-execution, time=1761418088.1236885 2025-10-25 18:48:08,123 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage handler-selection_started=1761418088.1236885 2025-10-25 18:48:08,123 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step handler-selection_started - 1761418088.1236885 2025-10-25 18:48:08,123 DEBUG (devtools.ya.core.plugin_loader) [MainThread] Load devtools.ya.handlers.make 2025-10-25 18:48:08,136 DEBUG (devtools.ya.core.yarg.config_files) [MainThread] Load data from config /home/runner/actions_runner/_work/ydb/ydb/ya.conf 2025-10-25 18:48:08,137 DEBUG (devtools.ya.core.yarg.config_files) [MainThread] Found 20 keys 2025-10-25 18:48:08,137 DEBUG (devtools.ya.core.yarg.populate) [MainThread] Use config file `/home/runner/actions_runner/_work/ydb/ydb/ya.conf` with `20` keys 2025-10-25 18:48:08,137 DEBUG (devtools.ya.core.yarg.populate) [MainThread] No aliases to inject 2025-10-25 18:48:08,138 DEBUG (devtools.ya.core.yarg.config_files) [MainThread] Unknown config parameter `use_atd_revisions_info` 2025-10-25 18:48:08,138 DEBUG (devtools.ya.core.yarg.config_files) [MainThread] Load data from config /home/runner/actions_runner/_work/ydb/ydb/build/internal/ya.conf 2025-10-25 18:48:08,138 DEBUG (devtools.ya.core.yarg.config_files) [MainThread] Found 9 keys 2025-10-25 18:48:08,138 DEBUG (devtools.ya.core.yarg.populate) [MainThread] Use config file `/home/runner/actions_runner/_work/ydb/ydb/build/internal/ya.conf` with `9` keys 2025-10-25 18:48:08,138 DEBUG (devtools.ya.core.yarg.populate) [MainThread] No aliases to inject 2025-10-25 18:48:08,138 DEBUG (devtools.ya.core.yarg.config_files) [MainThread] Unknown config parameter `bazel_remote_client_decompress` 2025-10-25 18:48:08,146 DEBUG (devtools.ya.build.build_opts) [MainThread] Failed to make int from size: 2TB. Will fallback to parse_size 2025-10-25 18:48:08,148 DEBUG (devtools.ya.core.common_opts) [MainThread] Could not read .ya_token file at /home/runner/.ya_token: [Errno 2] No such file or directory: '/home/runner/.ya_token' 2025-10-25 18:48:08,148 DEBUG (devtools.ya.core.common_opts) [MainThread] Could not read .ya_token file at /home/runner/.ya_token: [Errno 2] No such file or directory: '/home/runner/.ya_token' 2025-10-25 18:48:08,149 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=handler-selection, group=overall-execution, time=1761418088.1495314 2025-10-25 18:48:08,149 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage handler-selection_finished=1761418088.1495314 2025-10-25 18:48:08,149 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step handler-selection_finished - 1761418088.1495314 2025-10-25 18:48:08,149 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=modules-initialization-full, group=overall-execution, time=1761418088.149656 2025-10-25 18:48:08,149 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage modules-initialization-full_started=1761418088.149656 2025-10-25 18:48:08,149 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step modules-initialization-full_started - 1761418088.149656 2025-10-25 18:48:08,149 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Add [('params', ), ('hide_token', ), ('state', ), ('display', ), ('custom_file_log', ), ('display_log', ), ('vcs_type', ), ('self_info', ), ('fetcher_params', ), ('use_universal_fetcher_everywhere', ), ('docker_config_path', ), ('hide_token2', ), ('fetchers_storage', ), ('fetcher', ), ('showstack', ), ('profile', ), ('mlockall', ), ('event_queue', ), ('changelist_store', ), ('evlog', ), ('dump_debug', )] to ctx dict_keys(['uid', 'username', 'file_log', 'display_in_memory_log', 'file_in_memory_log', 'revision', 'vcs_type', 'exit', 'metrics_reporter', 'report', 'exit_code', 'lifecycle_ts', 'env_checker', 'fetchers_storage', 'tmp_dir', 'params', 'hide_token', 'state', 'display']) 2025-10-25 18:48:08,150 DEBUG (devtools.ya.core.respawn) [MainThread] Same as prev source root /home/runner/actions_runner/_work/ydb/ydb 2025-10-25 18:48:08,150 DEBUG (devtools.ya.core.respawn.pyver) [MainThread] No need to respawn to other ya-bin version 2025-10-25 18:48:08,150 DEBUG (devtools.ya.core.respawn) [MainThread] Unsetting YA_STDIN env var as respawn never happened 2025-10-25 18:48:08,150 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "params" initialized in 0.000296 2025-10-25 18:48:08,152 DEBUG (devtools.ya.core.sec) [MainThread] Found 0 secrets 2025-10-25 18:48:08,152 DEBUG (root) [MainThread] Update replacements in 2025-10-25 18:48:08,152 DEBUG (root) [MainThread] Add suppressing formatter to 2025-10-25 18:48:08,152 DEBUG (devtools.ya.core.sec) [MainThread] Found 0 secrets 2025-10-25 18:48:08,152 DEBUG (root) [MainThread] Add suppressing formatter to 2025-10-25 18:48:08,152 DEBUG (devtools.ya.core.sec) [MainThread] Found 0 secrets 2025-10-25 18:48:08,152 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "hide_token" initialized in 0.002156 2025-10-25 18:48:08,152 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "state" initialized in 0.000222 2025-10-25 18:48:08,152 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "display" initialized in 0.000053 2025-10-25 18:48:08,153 DEBUG (devtools.ya.core.sec) [MainThread] Found 0 secrets 2025-10-25 18:48:08,153 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "custom_file_log" initialized in 0.000900 2025-10-25 18:48:08,153 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "display_log" initialized in 0.000036 2025-10-25 18:48:08,154 DEBUG (yalibrary.vcs) [MainThread] detecting vcs from /home/runner/actions_runner/_work/ydb/ydb for paths: None 2025-10-25 18:48:08,154 DEBUG (yalibrary.vcs) [MainThread] common root: /home/runner/actions_runner/_work/ydb/ydb 2025-10-25 18:48:08,154 DEBUG (yalibrary.vcs) [MainThread] vcs root: /home/runner/actions_runner/_work/ydb/ydb (git) 2025-10-25 18:48:08,154 DEBUG (root) [MainThread] vcs type: git 2025-10-25 18:48:08,154 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "vcs_type" initialized in 0.000220 2025-10-25 18:48:08,154 DEBUG (devtools.ya.app) [MainThread] origin: github 2025-10-25 18:48:08,154 DEBUG (devtools.ya.app) [MainThread] python: sys.version_info(major=3, minor=12, micro=9, releaselevel='final', serial=0) 2025-10-25 18:48:08,154 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "self_info" initialized in 0.000119 2025-10-25 18:48:08,154 DEBUG (devtools.ya.app) [MainThread] Custom fetcher: None, fetcher parameters: [{'name': 'custom'}, {'name': 'proxy'}, {'name': 'skynet'}, {'name': 'mds'}, {'name': 'sandbox'}], sb_token none 2025-10-25 18:48:08,154 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetcher_params" initialized in 0.000073 2025-10-25 18:48:08,154 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "use_universal_fetcher_everywhere" initialized in 0.000002 2025-10-25 18:48:08,154 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "docker_config_path" initialized in 0.000002 2025-10-25 18:48:08,155 DEBUG (devtools.ya.core.sec) [MainThread] Found 0 secrets 2025-10-25 18:48:08,155 DEBUG (root) [MainThread] Update replacements in 2025-10-25 18:48:08,155 DEBUG (root) [MainThread] Update replacements in 2025-10-25 18:48:08,155 DEBUG (root) [MainThread] Update replacements in DisplayStreamHandler 2025-10-25 18:48:08,155 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "hide_token2" initialized in 0.001020 2025-10-25 18:48:08,155 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetchers_storage" initialized in 0.000063 2025-10-25 18:48:08,155 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetcher" initialized in 0.000002 2025-10-25 18:48:08,156 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "showstack" initialized in 0.000126 2025-10-25 18:48:08,156 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "profile" initialized in 0.000002 2025-10-25 18:48:08,156 DEBUG (devtools.ya.app) [MainThread] mlockall return code: 0 2025-10-25 18:48:08,156 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "mlockall" initialized in 0.000039 2025-10-25 18:48:08,156 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "event_queue" initialized in 0.000004 2025-10-25 18:48:08,156 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "changelist_store" initialized in 0.000202 2025-10-25 18:48:08,156 DEBUG (root) [MainThread] Event log file is /home/runner/actions_runner/_work/ydb/ydb/tmp/results/try_1/ya_evlog.jsonl 2025-10-25 18:48:08,156 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "evlog" initialized in 0.000395 2025-10-25 18:48:08,196 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "dump_debug" initialized in 0.039976 2025-10-25 18:48:08,197 DEBUG (devtools.ya.app) [MainThread] Run action on with params {'build_type': 'relwithdebinfo', 'sanitize': None, 'sanitizer_flags': [], 'lto': None, 'thinlto': None, 'musl': None, 'sanitize_coverage': None, 'use_afl': False, 'hardening': False, 'race': False, 'cuda_platform': 'optional', 'flags': {'OPENSOURCE': 'yes', 'USE_PREBUILT_TOOLS': 'no', 'APPLE_SDK_LOCAL': 'yes', 'USE_CLANG_CL': 'yes', 'USE_AIO': 'static', 'USE_ICONV': 'static', 'USE_IDN': 'static', 'CFLAGS': '-fno-omit-frame-pointer -Wno-unknown-argument', 'USE_EAT_MY_DATA': 'yes', 'DEBUGINFO_LINES_ONLY': 'yes', 'CONSISTENT_DEBUG': 'yes', 'TESTS_REQUESTED': 'yes', 'DISABLE_FLAKE8_MIGRATIONS': 'yes'}, 'host_flags': {'TESTS_REQUESTED': 'yes'}, 'custom_fetcher': None, 'fetcher_params': [{'name': 'custom'}, {'name': 'proxy'}, {'name': 'skynet'}, {'name': 'mds'}, {'name': 'sandbox'}], 'fetcher_params_str': None, 'use_universal_fetcher_everywhere': False, 'use_universal_fetcher_for_dist_results': False, 'clear_build': False, 'yndexing': False, 'yt_cluster': None, 'yt_root': None, 'yt_codenav_extra_opts': None, 'java_yndexing': False, 'kythe_to_proto_tool': None, 'py3_yndexing': False, 'py_yndexing': True, 'ts_yndexing': False, 'strict_inputs': False, 'sandboxing': False, 'default_node_requirements': {'network': 'restricted'}, 'default_node_requirements_str': None, 'build_results_report_file': '/home/runner/actions_runner/_work/ydb/ydb/tmp/results/try_1/report.json', 'build_report_type': 'canonical', 'build_results_resource_id': None, 'build_results_report_tests_only': False, 'report_skipped_suites': False, 'report_skipped_suites_only': False, 'use_links_in_report': False, 'report_config_path': None, 'dump_raw_results': False, 'json_line_report_file': None, 'external_py_files': False, 'continue_on_fail': False, 'print_statistics': True, 'statistics_out_dir': None, 'be_verbose': False, 'detailed_args': False, 'do_not_output_stderrs': False, 'output_style': 'make', 'mask_roots': False, 'status_refresh_interval': 0.1, 'do_emit_status': True, 'do_not_emit_nodes': [], 'use_roman_numerals': False, 'profile_to_file': None, 'stages_profile': None, 'misc_build_info_dir': None, 'debug_options': [], 'clear_ymake_cache': False, 'vcs_file': None, 'dump_file_path': None, 'trace_context_json': None, 'conf_debug_options': [], 'extra_conf': None, 'ignore_configure_errors': False, 'ymake_bin': None, 'no_ymake_resource': False, 'no_yabin_resource': False, 'no_caches_on_retry': False, 'no_ymake_retry': False, 'ymake_tool_servermode': False, 'ymake_pic_servermode': False, 'use_local_conf': True, 'local_conf_path': None, 'random_build_root': True, 'limit_build_root_size': False, 'build_threads': 64, 'link_threads': 12, 'custom_json': None, 'custom_context': None, 'ignore_nodes_exit_code': False, 'dump_graph': None, 'dump_graph_file': None, 'use_json_cache': True, 'visible': None, 'advanced': True, 'c_compiler': None, 'cxx_compiler': None, 'host_platform': None, 'host_platform_flags': {'OPENSOURCE': 'yes', 'USE_PREBUILT_TOOLS': 'no', 'APPLE_SDK_LOCAL': 'yes', 'USE_CLANG_CL': 'yes', 'USE_AIO': 'static', 'USE_ICONV': 'static', 'USE_IDN': 'static', 'CFLAGS': '-fno-omit-frame-pointer -Wno-unknown-argument'}, 'host_build_type': 'release', 'target_platforms': [], 'platform_schema_validation': False, 'hide_arm64_host_warning': False, 'add_result': [], 'add_host_result': [], 'replace_result': False, 'all_outputs_to_result': False, 'add_modules_to_results': False, 'gen_renamed_results': True, 'strip_packages_from_results': False, 'strip_binary_from_results': False, 'do_clear': False, 'show_command': [], 'show_timings': False, 'ext_progress': False, 'local_executor': True, 'executor_address': None, 'eager_execution': False, 'use_clonefile': True, 'runner_dir_outputs': True, 'dir_outputs_test_mode': True, 'schedule_strategy': 'deeper_first__lpt', 'force_build_depends': True, 'ignore_recurses': False, 'create_symlinks': True, 'symlink_root': None, 'set_nice_value': 10, 'request_content_uids': True, 'force_content_uids': False, 'validate_build_root_content': False, 'run_tests': 3, 'run_tests_size': 1, 'peerdirs_test_type': 'none', 'fail_fast': False, 'test_threads': 52, 'testing_split_factor': 0, 'test_prepare': False, 'cpu_detect_via_ram': True, 'list_tests': False, 'list_before_test': False, 'arcadia_tests_data_path': 'arcadia_tests_data', 'canonization_transport': None, 'canonize_tests': False, 'test_diff': None, 'canonization_backend': 'ydb-canondata.storage.yandexcloud.net', 'canonization_scheme': 'https', 'custom_canondata_path': None, 'inline_diff': False, 'max_test_comment_size': None, 'omitted_test_statuses': ['good', 'xfail', 'not_launched'], 'print_test_console_report': True, 'show_deselected_tests': False, 'show_metrics': False, 'show_passed_tests': False, 'show_skipped_tests': False, 'test_console_report': True, 'show_final_ok': True, 'build_coverage_report': False, 'clang_coverage': False, 'coverage': False, 'coverage_direct_upload_yt': True, 'coverage_exclude_regexp': None, 'coverage_failed_upload_uids_file': None, 'coverage_prefix_filter': None, 'coverage_report_path': None, 'coverage_succeed_upload_uids_file': None, 'coverage_upload_snapshot_name': None, 'coverage_verbose_resolve': False, 'coverage_yt_token_path': None, 'enable_contrib_coverage': False, 'enable_java_contrib_coverage': False, 'fast_clang_coverage_merge': False, 'go_coverage': False, 'java_coverage': False, 'merge_coverage': False, 'nlg_coverage': False, 'python_coverage': False, 'sancov_coverage': False, 'ts_coverage': False, 'upload_coverage_report': False, 'debugger_requested': False, 'gdb': False, 'pdb': False, 'dlv': False, 'dlv_args': None, 'random_ports': True, 'test_allow_graceful_shutdown': True, 'test_debug': False, 'test_disable_timeout': False, 'test_stderr': False, 'test_stdout': False, 'tests_retries': 1, 'test_binary_args': [], 'dump_test_environment': False, 'show_test_cwd': False, 'drop_graph_result_before_tests': False, 'strip_skipped_test_deps': False, 'strip_idle_build_results': False, 'backup_test_results': False, 'allure_report': None, 'junit_path': '/home/runner/actions_runner/_work/ydb/ydb/tmp/results/try_1/junit.xml', 'last_failed_tests': False, 'test_files_filter': [], 'test_size_filters': ['small', 'medium'], 'test_size_timeouts': {}, 'test_tag_string': None, 'test_tags_filter': [], 'test_type_filters': [], 'test_class_filters': [], 'tests_filters': [], 'tests_chunk_filters': [], 'style': False, 'regular_tests': False, 'fuzz_case_filename': None, 'fuzz_force_minimization': False, 'fuzz_local_store': False, 'fuzz_minimization_only': False, 'fuzz_node_timeout': None, 'fuzz_opts': '', 'fuzz_runs': None, 'fuzz_proof': 0, 'fuzzing': False, 'cache_fs_read': False, 'cache_fs_write': False, 'merge_split_tests': True, 'remove_result_node': True, 'remove_tos': False, 'test_fail_exit_code': '0', 'detect_leaks_in_pytest': True, 'fail_maven_export_with_tests': True, 'use_jstyle_server': True, 'setup_pythonpath_env': True, 'use_command_file_in_testtool': True, 'use_throttling': False, 'remove_implicit_data_path': True, 'no_tests_is_error': False, 'tests_limit_in_suite': 100000, 'cache_test_statuses': None, 'skip_cross_compiled_tests': True, 'propagate_test_timeout_info': False, 'ytexec_node_timeout': None, 'store_original_tracefile': False, 'ignored_properties_files': [], 'jstyle_runner_path': None, 'jvm_args': None, 'properties': {}, 'properties_files': [], 'disable_flake8_migrations': True, 'flake8_file_processing_delay': 1.5, 'disable_jstyle_migrations': False, 'dir_outputs': False, 'keep_full_test_logs': False, 'output_only_tests': False, 'save_test_outputs': True, 'dir_outputs_in_nodes': False, 'test_keep_symlinks': False, 'test_output_compression_filter': 'zstd', 'test_output_compression_level': 1, 'test_node_output_limit': None, 'profile_pytest': False, 'test_log_level': None, 'test_traceback': 'short', 'pytest_args': [], 'collect_cores': True, 'no_src_changes': False, 'private_ram_drive': False, 'private_net_ns': False, 'autocheck_mode': False, 'test_env': [], 'test_params': {}, 'force_create_frepkage': False, 'frepkage_root': 'UNSPECIFIED', 'frepkage_target_uid': None, 'run_tagged_tests_on_sandbox': False, 'run_tagged_tests_on_yt': False, 'ytexec_bin': None, 'ytexec_wrapper_m_cpu': 250, 'vanilla_execute_yt_token_path': None, 'ytexec_title_suffix': None, 'test_tool_bin': None, 'test_tool3_bin': None, 'profile_test_tool': [], 'cache_tests': False, 'test_types_fakeid': {}, 'test_fakeid': 'r13102898', 'force_retest': True, 'hermione_config': None, 'hermione_grep': None, 'hermione_test_paths': [], 'hermione_browsers': [], 'hermione_sets': [], 'hermione_gui': False, 'hermione_gui_auto_run': False, 'hermione_gui_no_open': False, 'hermione_gui_hostname': None, 'hermione_gui_port': None, 'junit_args': None, 'ttl': 14, 'oauth_token': None, 'oauth_token_path': None, 'docker_config_path': None, 'username': 'runner', 'ssh_keys': [], 'ssh_key_option_name': '--ssh-key', 'oauth_exchange_ssh_keys': True, 'store_oauth_token': True, 'ssh_user_option_name': '--user', 'sandbox': False, 'sandbox_url': 'https://sandbox.yandex-team.ru', 'resource_owner': 'runner', 'task_kill_timeout': None, 'sandbox_owner_option_name': '--owner', 'mds': False, 'mds_host': 'storage.yandex-team.ru', 'mds_port': 443, 'mds_namespace': 'devtools', 'mds_token': None, 'sonar': False, 'sonar_project_filters': [], 'sonar_properties': {}, 'sonar_do_not_compile': False, 'sonar_default_project_filter': False, 'sonar_java_args': [], 'output_root': '/home/runner/actions_runner/_work/ydb/ydb/tmp/out', 'suppress_outputs': [], 'default_suppress_outputs': ['.o', '.obj', '.mf', '..', '.cpf', '.cpsf', '.srclst', '.fake', '.vet.out', '.vet.txt', '.self.protodesc'], 'prefetch': False, 'generate_bin_dir': None, 'generate_lib_dir': None, 'install_dir': None, 'keep_temps': False, 'html_display': None, 'teamcity': False, 'profile_to': None, 'log_file': '/home/runner/actions_runner/_work/ydb/ydb/tmp/results/ya_log.txt', 'evlog_file': '/home/runner/actions_runner/_work/ydb/ydb/tmp/results/try_1/ya_evlog.jsonl', 'no_evlogs': False, 'dump_platform_to_evlog': False, 'dump_failed_node_info_to_evlog': False, 'evlog_dump_node_stat': False, 'compress_evlog': True, 'stdout': None, 'tools_cache': True, 'tools_cache_master': True, 'build_cache': True, 'build_cache_master': True, 'tools_cache_bin': None, 'tools_cache_ini': None, 'tools_cache_conf': {}, 'tools_cache_conf_str': [], 'build_cache_conf': {'cas_logging': 'true', 'graph_info': 'true'}, 'build_cache_conf_str': ['cas_logging=true', 'graph_info=true'], 'tools_cache_gl_conf': {}, 'tools_cache_gl_conf_str': [], 'tools_cache_size': 32212254720, 'strip_cache': False, 'strip_symlinks': False, 'symlinks_ttl': 604800, 'cache_stat': False, 'cache_codec': '', 'new_store': True, 'new_runner': True, 'new_store_ttl': 259200, 'cache_size': 2199023255552, 'auto_clean_results_cache': True, 'yt_proxy': '', 'yt_dir': '', 'yt_token': None, 'yt_token_path': None, 'yt_readonly': True, 'yt_max_cache_size': None, 'yt_store_ttl': 24, 'dist_cache_evict_binaries': False, 'dist_cache_evict_bundles': False, 'dist_cache_evict_cached': False, 'dist_cache_max_file_size': 209715200, 'dist_store_threads': 76, 'dist_cache_late_fetch': True, 'yt_store': False, 'yt_create_tables': False, 'yt_self_uid': False, 'yt_cache_filter': None, 'yt_store_codec': None, 'yt_replace_result': False, 'yt_replace_result_yt_upload_only': False, 'yt_replace_result_add_objects': False, 'yt_store_exclusive': False, 'yt_store_threads': 0, 'yt_store_wt': True, 'yt_store_refresh_on_read': False, 'yt_store_cpp_client': True, 'yt_store_probe_before_put': False, 'yt_store_probe_before_put_min_size': 0, 'bazel_remote_store': True, 'bazel_remote_baseuri': 'http://cachesrv.internal:8081', 'bazel_remote_username': 'cache_user', 'bazel_remote_password': None, 'bazel_remote_password_file': '/tmp/tmp.2OA8Z6ARX2', 'bazel_remote_readonly': False, 'warn_mode': ['dirloops', 'ChkPeers'], 'get_deps': None, 'dump_sources': False, 'export_to_maven': False, 'version': None, 'deploy': False, 'repository_id': None, 'repository_url': None, 'maven_settings': None, 'maven_output': None, 'javac_flags': {}, 'error_prone_flags': [], 'maven_no_recursive_deps': False, 'maven_exclude_transitive_deps': False, 'disable_scriptgen': False, 'pgo_add': False, 'pgo_path': None, 'pgo_user_path': [], 'force_pic': False, 'terminal_profile': {}, 'thin_checkout': False, 'testenv_report_dir': None, 'streaming_report_id': None, 'streaming_report_url': None, 'stream_partition': 0, 'streaming_task_id': None, 'keep_alive_streams': set(), 'streaming_stage_namespace': None, 'report_only_stages': False, 'report_to_ci': False, 'ci_logbroker_token': None, 'ci_topic': None, 'ci_source_id': None, 'ci_check_id': None, 'ci_check_type': None, 'ci_iteration_number': None, 'ci_task_id_string': None, 'ci_logbroker_partition_group': None, 'ci_use_ydb_topic_client': False, 'raw_params': None, 'preset_mapsmobi': False, 'preset_with_credits': False, 'preset_disable_customization': False, 'ya_threads': 64, 'dump_debug_path': None, 'dump_debug_enabled': True, 'compress_ymake_output': False, 'compress_ymake_output_codec': 'zstd08_1', 'ya_bin3_required': None, 'use_distbuild': False, 'json_prefix': None, 'share_results': False, 'graph_stat_path': None, 'dump_graph_execution_cost': False, 'download_artifacts': False, 'upload_to_remote_store': False, 'build_graph_cache_heater': False, 'build_graph_cache_dir': None, 'build_graph_cache_archive': None, 'build_graph_cache_cl': None, 'build_graph_cache_trust_cl': False, 'build_graph_autocheck_params': None, 'build_graph_autocheck_params_str': None, 'build_graph_cache_resource': None, 'build_graph_cache_from_sb': False, 'build_graph_source_root_pattern': 'SOURCE_ROOT', 'build_graph_result_dir': None, 'build_graph_arc_server': 'arc-vcs.yandex-team.ru:5623', 'build_graph_public_arc_server': 'api.arc-vcs.yandex-team.ru:6734', 'build_graph_use_ymake_cache_params': None, 'build_graph_use_ymake_cache_params_str': None, 'build_graph_use_public_api': False, 'abs_targets': ['/home/runner/actions_runner/_work/ydb/ydb'], 'rel_targets': ['.'], 'arc_root': '/home/runner/actions_runner/_work/ydb/ydb', 'bld_dir': '/home/runner/.ya/build', 'bld_root': '/home/runner/.ya/build/build_root', 'custom_build_directory': '/home/runner/.ya/build/build_root'} 2025-10-25 18:48:08,197 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=modules-initialization-full, group=overall-execution, time=1761418088.1979184 2025-10-25 18:48:08,197 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage modules-initialization-full_finished=1761418088.1979184 2025-10-25 18:48:08,198 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step modules-initialization-full_finished - 1761418088.1979184 2025-10-25 18:48:08,198 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=invoke-do_ya_make, group=overall-execution, time=1761418088.198089 2025-10-25 18:48:08,198 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage invoke-do_ya_make_started=1761418088.198089 2025-10-25 18:48:08,198 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step invoke-do_ya_make_started - 1761418088.198089 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=ya_make_handler, group=build_handler, time=1761418088.3334394 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage ya_make_handler_started=1761418088.3334394 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step ya_make_handler_started - 1761418088.3334394 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=context_generating, group=build_handler, time=1761418088.3336806 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage context_generating_started=1761418088.3336806 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step context_generating_started - 1761418088.3336806 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=build_graph_cache_configuration, group=build_handler, time=1761418088.3338032 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build_graph_cache_configuration_started=1761418088.3338032 2025-10-25 18:48:08,333 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build_graph_cache_configuration_started - 1761418088.3338032 2025-10-25 18:48:08,333 DEBUG (devtools.ya.build.ya_make) [MainThread] Build graph cache processing started 2025-10-25 18:48:08,333 DEBUG (devtools.ya.build.ya_make) [MainThread] Build graph cache processing disabled 2025-10-25 18:48:08,333 DEBUG (devtools.ya.build.ya_make) [MainThread] Build graph cache is not available in opensource 2025-10-25 18:48:08,334 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=build_graph_cache_configuration, group=build_handler, time=1761418088.3340027 2025-10-25 18:48:08,334 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build_graph_cache_configuration_finished=1761418088.3340027 2025-10-25 18:48:08,334 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build_graph_cache_configuration_finished - 1761418088.3340027 2025-10-25 18:48:08,334 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=context_creation, group=ya_make, time=1761418088.3342392 2025-10-25 18:48:08,334 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage context_creation_started=1761418088.3342392 2025-10-25 18:48:08,334 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step context_creation_started - 1761418088.3342392 2025-10-25 18:48:08,336 DEBUG (yalibrary.toolscache) [MainThread] Tools cache uses passed opts 2025-10-25 18:48:08,336 DEBUG (yalibrary.toolscache) [MainThread] Tools cache parameters: tc enabled=True, tc master=True, ac enabled=True, ac master=True, tc_lock_file=/home/runner/.ya/tools/v4/.cache_lock, ac_lock_file=/home/runner/.ya/build/cache/7/.cache_lock, binary=None, ini=None, tc_conf={}, ac_conf={'cas_logging': 'true', 'graph_info': 'true'}, gl_conf={} 2025-10-25 18:48:08,336 DEBUG (devtools.ya.build.ya_make) [MainThread] content UIDs enabled by request 2025-10-25 18:48:08,338 DEBUG (devtools.ya.build.ya_make) [Misc-00] Using '/tmp/tmp.2OA8Z6ARX2' file to obtain bazel remote password 2025-10-25 18:48:08,339 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=build_graph_and_tests, group=graph, time=1761418088.3391583 2025-10-25 18:48:08,339 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build_graph_and_tests_started=1761418088.3391583 2025-10-25 18:48:08,339 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build_graph_and_tests_started - 1761418088.3391583 2025-10-25 18:48:08,339 DEBUG (devtools.ya.build.graph) [Misc-01] Collect vcs info 2025-10-25 18:48:08,340 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/ya.conf.json 2025-10-25 18:48:08,340 DEBUG (yalibrary.vcs) [Misc-01] detecting vcs from /home/runner/actions_runner/_work/ydb/ydb for paths: ['/home/runner/actions_runner/_work/ydb/ydb'] 2025-10-25 18:48:08,340 DEBUG (yalibrary.vcs) [Misc-01] common root: /home/runner/actions_runner/_work/ydb/ydb 2025-10-25 18:48:08,341 DEBUG (yalibrary.vcs) [Misc-01] vcs root: /home/runner/actions_runner/_work/ydb/ydb (git) 2025-10-25 18:48:08,341 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/platform/clang/clang16.json 2025-10-25 18:48:08,343 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/platform/clang/clang18.json 2025-10-25 18:48:08,345 DEBUG (devtools.ya.build.graph) [MainThread] flags: { "APPLE_SDK_LOCAL": "yes", "CFLAGS": "-fno-omit-frame-pointer -Wno-unknown-argument", "CONSISTENT_DEBUG": "yes", "DEBUGINFO_LINES_ONLY": "yes", "DISABLE_FLAKE8_MIGRATIONS": "yes", "OPENSOURCE": "yes", "TESTS_REQUESTED": "yes", "USE_AIO": "static", "USE_CLANG_CL": "yes", "USE_EAT_MY_DATA": "yes", "USE_ICONV": "static", "USE_IDN": "static", "USE_PREBUILT_TOOLS": "no" } 2025-10-25 18:48:08,345 DEBUG (devtools.ya.build.graph) [MainThread] host toolchain: { "bottle_name": "clang18", "build_type": "release", "env": { "CPATH": [ "" ], "LIBRARY_PATH": [ "" ], "SDKROOT": [ "" ] }, "executable_path": "c++", "flags": { "APPLE_SDK_LOCAL": "yes", "CFLAGS": "-fno-omit-frame-pointer -Wno-unknown-argument", "CLANG_COVERAGE": "no", "CONSISTENT_DEBUG": "yes", "NO_DEBUGINFO": "yes", "OPENSOURCE": "yes", "TIDY": "no", "TOOL_BUILD_MODE": "yes", "TRAVERSE_RECURSE": "no", "USE_AIO": "static", "USE_CLANG_CL": "yes", "USE_ICONV": "static", "USE_IDN": "static", "USE_PREBUILT_TOOLS": "no" }, "formula": { "by_platform": { "darwin-arm64": { "uri": "sbr:7599484265" }, "darwin-x86_64": { "uri": "sbr:7599517506" }, "linux-aarch64": { "uri": "sbr:7599285566" }, "linux-x86_64": { "uri": "sbr:7599469156" }, "win32-x86_64": { "uri": "sbr:7599422144" } } }, "name": "clang18", "params": { "c_compiler": "$(CLANG-2518231432)/bin/clang", "cxx_compiler": "$(CLANG-2518231432)/bin/clang++", "llvm-symbolizer": "$(CLANG-2518231432)/bin/llvm-symbolizer", "match_root": "CLANG-2518231432", "nm": "$(CLANG-2518231432)/bin/llvm-nm", "objcopy": "$(CLANG-2518231432)/bin/llvm-objcopy", "profiles": "$(XCODE_TOOLS_ROOT-sbr:799017771)/Xcode/Contents/Developer/Platforms/iPhoneOS.platform/Developer/Library/CoreSimulator/Profiles", "simctl": "$(XCODE_TOOLS_ROOT-sbr:799017771)/Xcode/SystemRoot/PrivateFrameworks/CoreSimulator.framework/Resources/bin/simctl", "strip": "$(CLANG-2518231432)/bin/llvm-strip", "type": "clang", "use_bundle": true, "version": "18" }, "platform": { "host": { "arch": "x86_64", "os": "LINUX", "toolchain": "default", "visible_name": "clang18" }, "target": { "arch": "x86_64", "os": "LINUX", "toolchain": "default", "visible_name": "clang18" } }, "tool_var": "CLANG-2518231432" } 2025-10-25 18:48:08,345 DEBUG (devtools.ya.build.graph) [MainThread] target toolchain: { "bottle_name": "clang18", "env": { "CPATH": [ "" ], "LIBRARY_PATH": [ "" ], "SDKROOT": [ "" ] }, "executable_path": "c++", "formula": { "by_platform": { "darwin-arm64": { "uri": "sbr:7599484265" }, "darwin-x86_64": { "uri": "sbr:7599517506" }, "linux-aarch64": { "uri": "sbr:7599285566" }, "linux-x86_64": { "uri": "sbr:7599469156" }, "win32-x86_64": { "uri": "sbr:7599422144" } } }, "name": "clang18", "params": { "c_compiler": "$(CLANG-2518231432)/bin/clang", "cxx_compiler": "$(CLANG-2518231432)/bin/clang++", "llvm-symbolizer": "$(CLANG-2518231432)/bin/llvm-symbolizer", "match_root": "CLANG-2518231432", "nm": "$(CLANG-2518231432)/bin/llvm-nm", "objcopy": "$(CLANG-2518231432)/bin/llvm-objcopy", "profiles": "$(XCODE_TOOLS_ROOT-sbr:799017771)/Xcode/Contents/Developer/Platforms/iPhoneOS.platform/Developer/Library/CoreSimulator/Profiles", "simctl": "$(XCODE_TOOLS_ROOT-sbr:799017771)/Xcode/SystemRoot/PrivateFrameworks/CoreSimulator.framework/Resources/bin/simctl", "strip": "$(CLANG-2518231432)/bin/llvm-strip", "type": "clang", "use_bundle": true, "version": "18" }, "platform": { "host": { "arch": "x86_64", "os": "LINUX", "toolchain": "default", "visible_name": "clang18" }, "target": { "arch": "x86_64", "os": "LINUX", "toolchain": "default", "visible_name": "clang18" } }, "platform_name": "DEFAULT-LINUX-X86_64", "tool_var": "CLANG-2518231432" } 2025-10-25 18:48:08,345 DEBUG (yalibrary.tools) [MainThread] Using old-style toolchain for: ymake 2025-10-25 18:48:08,345 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/ymake/public.resources.json 2025-10-25 18:48:08,345 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] ymake: try to fetch by {'darwin': {'uri': 'sbr:8069587979'}, 'darwin-arm64': {'uri': 'sbr:8069587058'}, 'linux': {'uri': 'sbr:8069590186'}, 'linux-aarch64': {'uri': 'sbr:8069586009'}, 'win32-clang-cl': {'uri': 'sbr:8069588665'}} for 'linux' 2025-10-25 18:48:08,345 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] ymake: will use 'linux' platform 2025-10-25 18:48:08,346 DEBUG (yalibrary.fetcher.resource_fetcher) [MainThread] Fetching 8069590186 from sbr:8069590186 to /home/runner/.ya/tools/v4/8069590186 dir, post_process=0) 2025-10-25 18:48:08,346 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/mapping.conf.json 2025-10-25 18:48:08,347 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/ext_mapping.conf.json 2025-10-25 18:48:08,355 DEBUG (yalibrary.toolscache) [MainThread] Tools cache attempt: (request for resource 8069590186) 2025-10-25 18:48:08,355 DEBUG (yalibrary.toolscache) [MainThread] Tools cache server resource download/parameters 2025-10-25 18:48:08,355 DEBUG (yalibrary.tools) [MainThread] Using old-style toolchain for: ya-tc 2025-10-25 18:48:08,355 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/ya-tc/public.resources.json 2025-10-25 18:48:08,356 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] ya-tc: try to fetch by {'darwin': {'uri': 'sbr:6812263131'}, 'darwin-arm64': {'uri': 'sbr:6812261994'}, 'linux': {'uri': 'sbr:6812260917'}, 'linux-aarch64': {'uri': 'sbr:6812259929'}} for 'linux' 2025-10-25 18:48:08,356 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] ya-tc: will use 'linux' platform 2025-10-25 18:48:08,356 DEBUG (yalibrary.fetcher.resource_fetcher) [MainThread] Fetching 6812260917 from sbr:6812260917 to /home/runner/.ya/tools/v4/6812260917 dir, post_process=0) 2025-10-25 18:48:08,356 DEBUG (yalibrary.toolscache) [MainThread] tc cache stats: None 2025-10-25 18:48:08,356 DEBUG (yalibrary.fetcher.cache_helper) [MainThread] Resource seems to be installed in /home/runner/.ya/tools/v4/6812260917 2025-10-25 18:48:08,356 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] ya-tc: successfully fetched into /home/runner/.ya/tools/v4/6812260917 2025-10-25 18:48:08,356 DEBUG (yalibrary.tools) [MainThread] Using old-style toolchain for: ya-tc 2025-10-25 18:48:08,356 DEBUG (yalibrary.toolscache) [MainThread] tc cache stats: None 2025-10-25 18:48:08,356 DEBUG (yalibrary.toolscache) [MainThread] Tools cache server resource download/parameters done: id=6812260917, full_path=/home/runner/.ya/tools/v4/6812260917/ya-tc 2025-10-25 18:48:08,360 DEBUG (yalibrary.toolscache) [MainThread] Tools cache (request for resource 8069590186) address: (2459, 47641, 'unix:/home/runner/.ya/tools/v4/psingpvZ7OZ.tmp') 2025-10-25 18:48:08,366 DEBUG (yalibrary.toolscache) [MainThread] tc cache stats: TotalKnownSize: 61964288 TotalKnownSizeLocked: 22249472 Master: true TotalDBSize: 81920 ToolCount: 2 ProcessesCount: 2 2025-10-25 18:48:08,366 DEBUG (yalibrary.fetcher.cache_helper) [MainThread] Resource seems to be installed in /home/runner/.ya/tools/v4/8069590186 2025-10-25 18:48:08,366 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] ymake: successfully fetched into /home/runner/.ya/tools/v4/8069590186 2025-10-25 18:48:08,366 DEBUG (exts.timer) [MainThread] Timer devtools.ya.build.graph, stage fetch ymake: 0.021332263946533203 2025-10-25 18:48:08,367 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=gen-graph-default-linux-x86_64-relwithdebinfo-nopic, group=graph, time=1761418088.3674579 2025-10-25 18:48:08,368 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-default-linux-x86_64-relwithdebinfo-nopic_started=1761418088.3674579 2025-10-25 18:48:08,368 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-default-linux-x86_64-relwithdebinfo-nopic_started - 1761418088.3674579 2025-10-25 18:48:08,368 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Start stage tag=gen-graph-default-linux-x86_64-relwithdebinfo-pic, group=graph, time=1761418088.3679051 2025-10-25 18:48:08,368 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage gen-graph-default-linux-x86_64-relwithdebinfo-pic_started=1761418088.3679051 2025-10-25 18:48:08,368 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step gen-graph-default-linux-x86_64-relwithdebinfo-pic_started - 1761418088.3679051 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=get-tools, group=graph, time=1761418088.3679929 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage get-tools_started=1761418088.3679929 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step get-tools_started - 1761418088.3679929 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=waiting-tool-targets, group=graph, time=1761418088.3693023 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage waiting-tool-targets_started=1761418088.3693023 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step waiting-tool-targets_started - 1761418088.3693023 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Start stage tag=gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-pic, group=graph, time=1761418088.368902 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-pic_started=1761418088.368902 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-pic_started - 1761418088.368902 2025-10-25 18:48:08,369 DEBUG (yalibrary.guards) [ThreadPoolExecutor-0_1] Enter guard fetch with value None 2025-10-25 18:48:08,369 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-nopic, group=graph, time=1761418088.3695092 2025-10-25 18:48:08,370 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-nopic_started=1761418088.3695092 2025-10-25 18:48:08,370 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-nopic_started - 1761418088.3695092 2025-10-25 18:48:08,370 DEBUG (yalibrary.guards) [ThreadPoolExecutor-0_0] Enter guard fetch with value None 2025-10-25 18:48:08,370 DEBUG (yalibrary.vcs.vcsversion) [Misc-01] b'fatal: No names found, cannot describe anything.\n' Running git describe --exact-match --tags HEAD failed with exit code 128 2025-10-25 18:48:08,373 DEBUG (yalibrary.vcs.vcsversion) [Misc-01] b'fatal: No names found, cannot describe anything.\n' Running git describe --exact-match --all HEAD failed with exit code 128 2025-10-25 18:48:08,376 DEBUG (yalibrary.vcs.vcsversion) [Misc-01] Git info commit:b'2f764428d3a97d19101d362016bd30c4b85dfdd3', author:b'YDBot ', summary:b'Merge fc735a4c0b25a00e54cc5944dd274a486ef7ed81 into 480e8a0f91a961f7ab44344eceadb8fb4f62aa28', svn_id:b'' 2025-10-25 18:48:08,376 DEBUG (yalibrary.vcs.vcsversion) [Misc-01] Other data: Other info: Build by: runner Top src dir: /home/runner/actions_runner/_work/ydb/ydb Top build dir: /home/runner/.ya/build Hostname: ghrun-yxfh4dbyfi Host information: Linux ghrun-yxfh4dbyfi 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64 2025-10-25 18:48:08,376 DEBUG (devtools.ya.build.graph) [Misc-01] Got version json "{\n \"ARCADIA_PATCH_NUMBER\": 1,\n \"ARCADIA_SOURCE_HG_HASH\": \"2f764428d3a97d19101d362016bd30c4b85dfdd3\",\n \"ARCADIA_SOURCE_LAST_AUTHOR\": \"YDBot \",\n \"ARCADIA_SOURCE_LAST_CHANGE\": -1,\n \"ARCADIA_SOURCE_PATH\": \"/home/runner/actions_runner/_work/ydb/ydb\",\n \"ARCADIA_SOURCE_REVISION\": -1,\n \"ARCADIA_SOURCE_URL\": \"\",\n \"ARCADIA_TAG\": \"\",\n \"BRANCH\": \"\",\n \"BUILD_DATE\": \"2025-10-25T18:48:08.000000Z\",\n \"BUILD_HOST\": \"ghrun-yxfh4dbyfi\",\n \"BUILD_TIMESTAMP\": 1761418088,\n \"BUILD_USER\": \"runner\",\n \"CUSTOM_VERSION\": \"\",\n \"DIRTY\": \"\",\n \"PROGRAM_VERSION\": \"Git info:\\n Commit: 2f764428d3a97d19101d362016bd30c4b85dfdd3\\n Branch: \\n Author: YDBot \\n Summary: Merge fc735a4c0b25a00e54cc5944dd274a486ef7ed81 into 480e8a0f91a961f7ab44344eceadb8fb4f62aa28\\n\\nOther info:\\n Build by: runner\\n Top src dir: /home/runner/actions_runner/_work/ydb/ydb\\n Top build dir: /home/runner/.ya/build\\n Hostname: ghrun-yxfh4dbyfi\\n Host information: \\n Linux ghrun-yxfh4dbyfi 5.15.0-157-generic #167-Ubuntu SMP Wed Sep 17 21:35:53 UTC 2025 x86_64\\n\\n \",\n \"RELEASE_VERSION\": \"\",\n \"SCM_DATA\": \"Git info:\\n Commit: 2f764428d3a97d19101d362016bd30c4b85dfdd3\\n Branch: \\n Author: YDBot \\n Summary: Merge fc735a4c0b25a00e54cc5944dd274a486ef7ed81 into 480e8a0f91a961f7ab44344eceadb8fb4f62aa28\\n\",\n \"VCS\": \"git\"\n}" 2025-10-25 18:48:08,376 DEBUG (exts.timer) [Misc-01] Timer get_version_info, stage vcs info: 0.0369570255279541 2025-10-25 18:48:08,401 DEBUG (devtools.ya.build.genconf) [ThreadPoolExecutor-0_0] Generating conf into /home/runner/.ya/build/conf/dist-relwithdebinfo-d7dccb172b004b68ccf1881de215d369/ymake.conf with cmd ['/home/runner/.ya/tools/ce4cd92b15_d/ya-bin', '-B', '/home/runner/actions_runner/_work/ydb/ydb/build/ymake_conf.py', '/home/runner/actions_runner/_work/ydb/ydb', 'dist-relwithdebinfo', 'no', '--toolchain-params', 'eyJib3R0bGVfbmFtZSI6ImNsYW5nMTgiLCJlbnYiOnsiQ1BBVEgiOlsiIl0sIkxJQlJBUllfUEFUSCI6WyIiXSwiU0RLUk9PVCI6WyIiXX0sImV4ZWN1dGFibGVfcGF0aCI6ImMrKyIsImZvcm11bGEiOnsiYnlfcGxhdGZvcm0iOnsiZGFyd2luLWFybTY0Ijp7InVyaSI6InNicjo3NTk5NDg0MjY1In0sImRhcndpbi14ODZfNjQiOnsidXJpIjoic2JyOjc1OTk1MTc1MDYifSwibGludXgtYWFyY2g2NCI6eyJ1cmkiOiJzYnI6NzU5OTI4NTU2NiJ9LCJsaW51eC14ODZfNjQiOnsidXJpIjoic2JyOjc1OTk0NjkxNTYifSwid2luMzIteDg2XzY0Ijp7InVyaSI6InNicjo3NTk5NDIyMTQ0In19fSwibmFtZSI6ImNsYW5nMTgiLCJwYXJhbXMiOnsiY19jb21waWxlciI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2NsYW5nIiwiY3h4X2NvbXBpbGVyIjoiJChDTEFORy0yNTE4MjMxNDMyKS9iaW4vY2xhbmcrKyIsImxsdm0tc3ltYm9saXplciI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2xsdm0tc3ltYm9saXplciIsIm1hdGNoX3Jvb3QiOiJDTEFORy0yNTE4MjMxNDMyIiwibm0iOiIkKENMQU5HLTI1MTgyMzE0MzIpL2Jpbi9sbHZtLW5tIiwib2JqY29weSI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2xsdm0tb2JqY29weSIsInByb2ZpbGVzIjoiJChYQ09ERV9UT09MU19ST09ULXNicjo3OTkwMTc3NzEpL1hjb2RlL0NvbnRlbnRzL0RldmVsb3Blci9QbGF0Zm9ybXMvaVBob25lT1MucGxhdGZvcm0vRGV2ZWxvcGVyL0xpYnJhcnkvQ29yZVNpbXVsYXRvci9Qcm9maWxlcyIsInNpbWN0bCI6IiQoWENPREVfVE9PTFNfUk9PVC1zYnI6Nzk5MDE3NzcxKS9YY29kZS9TeXN0ZW1Sb290L1ByaXZhdGVGcmFtZXdvcmtzL0NvcmVTaW11bGF0b3IuZnJhbWV3b3JrL1Jlc291cmNlcy9iaW4vc2ltY3RsIiwic3RyaXAiOiIkKENMQU5HLTI1MTgyMzE0MzIpL2Jpbi9sbHZtLXN0cmlwIiwidHlwZSI6ImNsYW5nIiwidXNlX2J1bmRsZSI6dHJ1ZSwidmVyc2lvbiI6IjE4In0sInBsYXRmb3JtIjp7Imhvc3QiOnsiYXJjaCI6Ing4Nl82NCIsIm9zIjoiTElOVVgiLCJ0b29sY2hhaW4iOiJkZWZhdWx0IiwidmlzaWJsZV9uYW1lIjoiY2xhbmcxOCJ9LCJ0YXJnZXQiOnsiYXJjaCI6Ing4Nl82NCIsIm9zIjoiTElOVVgiLCJ0b29sY2hhaW4iOiJkZWZhdWx0IiwidmlzaWJsZV9uYW1lIjoiY2xhbmcxOCJ9fSwicGxhdGZvcm1fbmFtZSI6IkRFRkFVTFQtTElOVVgtWDg2XzY0IiwidG9vbF92YXIiOiJDTEFORy0yNTE4MjMxNDMyIn0=', '-l', '-D', 'APPLE_SDK_LOCAL=yes', '-D', 'CFLAGS=-fno-omit-frame-pointer -Wno-unknown-argument', '-D', 'CLANG18=yes', '-D', 'CONSISTENT_DEBUG=yes', '-D', 'DEBUGINFO_LINES_ONLY=yes', '-D', 'DISABLE_FLAKE8_MIGRATIONS=yes', '-D', 'FORCE_NO_PIC=yes', '-D', 'IS_CROSS_SANITIZE=yes', '-D', 'OPENSOURCE=yes', '-D', 'TESTS_REQUESTED=yes', '-D', 'TRAVERSE_DEPENDS=yes', '-D', 'TRAVERSE_RECURSE_FOR_TESTS=yes', '-D', 'USE_AIO=static', '-D', 'USE_CLANG_CL=yes', '-D', 'USE_EAT_MY_DATA=yes', '-D', 'USE_ICONV=static', '-D', 'USE_IDN=static', '-D', 'USE_PREBUILT_TOOLS=no', '-D', 'YA=yes'] and env {'PATH': '/home/runner/actions_runner/_work/ydb/ydb/ydb/ci/scripts:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/snap/bin', 'Y_PYTHON_ENTRY_POINT': ':main'} 2025-10-25 18:48:08,401 DEBUG (devtools.ya.build.genconf) [ThreadPoolExecutor-0_1] Generating conf into /home/runner/.ya/build/conf/dist-relwithdebinfo-7757b2832eec31f1e33768bc18f480e6/ymake.conf with cmd ['/home/runner/.ya/tools/ce4cd92b15_d/ya-bin', '-B', '/home/runner/actions_runner/_work/ydb/ydb/build/ymake_conf.py', '/home/runner/actions_runner/_work/ydb/ydb', 'dist-relwithdebinfo', 'no', '--toolchain-params', 'eyJib3R0bGVfbmFtZSI6ImNsYW5nMTgiLCJlbnYiOnsiQ1BBVEgiOlsiIl0sIkxJQlJBUllfUEFUSCI6WyIiXSwiU0RLUk9PVCI6WyIiXX0sImV4ZWN1dGFibGVfcGF0aCI6ImMrKyIsImZvcm11bGEiOnsiYnlfcGxhdGZvcm0iOnsiZGFyd2luLWFybTY0Ijp7InVyaSI6InNicjo3NTk5NDg0MjY1In0sImRhcndpbi14ODZfNjQiOnsidXJpIjoic2JyOjc1OTk1MTc1MDYifSwibGludXgtYWFyY2g2NCI6eyJ1cmkiOiJzYnI6NzU5OTI4NTU2NiJ9LCJsaW51eC14ODZfNjQiOnsidXJpIjoic2JyOjc1OTk0NjkxNTYifSwid2luMzIteDg2XzY0Ijp7InVyaSI6InNicjo3NTk5NDIyMTQ0In19fSwibmFtZSI6ImNsYW5nMTgiLCJwYXJhbXMiOnsiY19jb21waWxlciI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2NsYW5nIiwiY3h4X2NvbXBpbGVyIjoiJChDTEFORy0yNTE4MjMxNDMyKS9iaW4vY2xhbmcrKyIsImxsdm0tc3ltYm9saXplciI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2xsdm0tc3ltYm9saXplciIsIm1hdGNoX3Jvb3QiOiJDTEFORy0yNTE4MjMxNDMyIiwibm0iOiIkKENMQU5HLTI1MTgyMzE0MzIpL2Jpbi9sbHZtLW5tIiwib2JqY29weSI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2xsdm0tb2JqY29weSIsInByb2ZpbGVzIjoiJChYQ09ERV9UT09MU19ST09ULXNicjo3OTkwMTc3NzEpL1hjb2RlL0NvbnRlbnRzL0RldmVsb3Blci9QbGF0Zm9ybXMvaVBob25lT1MucGxhdGZvcm0vRGV2ZWxvcGVyL0xpYnJhcnkvQ29yZVNpbXVsYXRvci9Qcm9maWxlcyIsInNpbWN0bCI6IiQoWENPREVfVE9PTFNfUk9PVC1zYnI6Nzk5MDE3NzcxKS9YY29kZS9TeXN0ZW1Sb290L1ByaXZhdGVGcmFtZXdvcmtzL0NvcmVTaW11bGF0b3IuZnJhbWV3b3JrL1Jlc291cmNlcy9iaW4vc2ltY3RsIiwic3RyaXAiOiIkKENMQU5HLTI1MTgyMzE0MzIpL2Jpbi9sbHZtLXN0cmlwIiwidHlwZSI6ImNsYW5nIiwidXNlX2J1bmRsZSI6dHJ1ZSwidmVyc2lvbiI6IjE4In0sInBsYXRmb3JtIjp7Imhvc3QiOnsiYXJjaCI6Ing4Nl82NCIsIm9zIjoiTElOVVgiLCJ0b29sY2hhaW4iOiJkZWZhdWx0IiwidmlzaWJsZV9uYW1lIjoiY2xhbmcxOCJ9LCJ0YXJnZXQiOnsiYXJjaCI6Ing4Nl82NCIsIm9zIjoiTElOVVgiLCJ0b29sY2hhaW4iOiJkZWZhdWx0IiwidmlzaWJsZV9uYW1lIjoiY2xhbmcxOCJ9fSwicGxhdGZvcm1fbmFtZSI6IkRFRkFVTFQtTElOVVgtWDg2XzY0IiwidG9vbF92YXIiOiJDTEFORy0yNTE4MjMxNDMyIn0=', '-l', '-D', 'APPLE_SDK_LOCAL=yes', '-D', 'CFLAGS=-fno-omit-frame-pointer -Wno-unknown-argument', '-D', 'CLANG18=yes', '-D', 'CONSISTENT_DEBUG=yes', '-D', 'DEBUGINFO_LINES_ONLY=yes', '-D', 'DISABLE_FLAKE8_MIGRATIONS=yes', '-D', 'IS_CROSS_SANITIZE=yes', '-D', 'OPENSOURCE=yes', '-D', 'TESTS_REQUESTED=yes', '-D', 'TRAVERSE_DEPENDS=yes', '-D', 'TRAVERSE_RECURSE_FOR_TESTS=yes', '-D', 'USE_AIO=static', '-D', 'USE_CLANG_CL=yes', '-D', 'USE_EAT_MY_DATA=yes', '-D', 'USE_ICONV=static', '-D', 'USE_IDN=static', '-D', 'USE_PREBUILT_TOOLS=no', '-D', 'YA=yes'] and env {'PATH': '/home/runner/actions_runner/_work/ydb/ydb/ydb/ci/scripts:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/snap/bin', 'Y_PYTHON_ENTRY_POINT': ':main'} 2025-10-25 18:48:08,527 DEBUG (devtools.ya.build.genconf) [ThreadPoolExecutor-0_1] Copy conf /home/runner/.ya/build/conf/dist-relwithdebinfo-7757b2832eec31f1e33768bc18f480e6/ymake.conf to /home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a/ymake.conf 2025-10-25 18:48:08,527 DEBUG (yalibrary.guards) [ThreadPoolExecutor-0_1] Exit guard fetch with value None 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Finish stage tag=gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-pic, group=graph, time=1761418088.527981 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-pic_finished=1761418088.527981 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-pic_finished - 1761418088.527981 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Start stage tag=gen-graph-json-default-linux-x86_64-relwithdebinfo-pic, group=graph, time=1761418088.5281982 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage gen-graph-json-default-linux-x86_64-relwithdebinfo-pic_started=1761418088.5281982 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step gen-graph-json-default-linux-x86_64-relwithdebinfo-pic_started - 1761418088.5281982 2025-10-25 18:48:08,528 DEBUG (devtools.ya.build.ymake2) [ThreadPoolExecutor-0_1] Run gen graph with {'grab_stderr': True, 'mode': 'dist', 'dump_graph': 'json', 'check': True, '_purpose': 'default-linux-x86_64-relwithdebinfo-pic', 'cpp': True, 'custom_build_directory': '/home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a_d357a1f7839b099012272bcb9853ec19', 'build_type': 'relwithdebinfo', 'abs_targets': ['/home/runner/actions_runner/_work/ydb/ydb'], 'debug_options': [], 'custom_conf': '/home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a/ymake.conf', 'continue_on_fail': False, 'ymake_bin': None, 'warn_mode': ['dirloops', 'ChkPeers'], 'build_depends': 3, 'arcadia_tests_data_path': '/home/runner/actions_runner/_work/ydb/arcadia_tests_data', 'checkout_data_by_ya': False, 'strict_inputs': False, 'dump_inputs_map': False, 'ev_listener': .event_listener_debug_id_wrapper at 0x7f31e29d2520>, 'enabled_events': 'dGT', 'no_caches_on_retry': False, 'no_ymake_retry': False, 'disable_customization': 0, 'dump_tests': '/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/test.dart', 'dump_make_files': '/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/makefiles.dart'} 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.yarg.behaviour) [ThreadPoolExecutor-0_1] Found unused args ['grab_stderr'] 2025-10-25 18:48:08,528 DEBUG (devtools.ya.build.prefetch) [ThreadPoolExecutor-0_1] prefetch disabled 2025-10-25 18:48:08,528 DEBUG (devtools.ya.core.event_handling.base_subscriber) [ThreadPoolExecutor-0_1] Subscribing PrintProgressSubscriber to event_queue 2025-10-25 18:48:08,529 DEBUG (yalibrary.tools) [ThreadPoolExecutor-0_1] Using old-style toolchain for: ymake 2025-10-25 18:48:08,529 DEBUG (devtools.ya.build.ymake2.run_ymake) [ThreadPoolExecutor-0_1] run: '/home/runner/.ya/tools/v4/8069590186/ymake --depends-like-recurse --warn dirloops,ChkPeers --write-meta-data /home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmp6gyy3_ev --config /home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a/ymake.conf --plugins-root /home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins --build-root /home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a_d357a1f7839b099012272bcb9853ec19 --test-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/test.dart --tests-data-root /home/runner/actions_runner/_work/ydb/arcadia_tests_data --makefiles-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/makefiles.dart --dump-build-plan - --quiet --events dGT /home/runner/actions_runner/_work/ydb/ydb' with env: { } 2025-10-25 18:48:08,529 DEBUG (devtools.ya.build.genconf) [ThreadPoolExecutor-0_0] Copy conf /home/runner/.ya/build/conf/dist-relwithdebinfo-d7dccb172b004b68ccf1881de215d369/ymake.conf to /home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7/ymake.conf 2025-10-25 18:48:08,532 DEBUG (yalibrary.guards) [ThreadPoolExecutor-0_0] Exit guard fetch with value None 2025-10-25 18:48:08,532 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-nopic, group=graph, time=1761418088.5326774 2025-10-25 18:48:08,532 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-nopic_finished=1761418088.5326774 2025-10-25 18:48:08,532 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-gen-opts-default-linux-x86_64-relwithdebinfo-nopic_finished - 1761418088.5326774 2025-10-25 18:48:08,532 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=gen-graph-json-default-linux-x86_64-relwithdebinfo-nopic, group=graph, time=1761418088.5329754 2025-10-25 18:48:08,533 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-json-default-linux-x86_64-relwithdebinfo-nopic_started=1761418088.5329754 2025-10-25 18:48:08,533 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-json-default-linux-x86_64-relwithdebinfo-nopic_started - 1761418088.5329754 2025-10-25 18:48:08,533 DEBUG (devtools.ya.build.ymake2) [ThreadPoolExecutor-0_0] Run gen graph with {'grab_stderr': True, 'mode': 'dist', 'dump_graph': 'json', 'check': True, '_purpose': 'default-linux-x86_64-relwithdebinfo-nopic', 'cpp': True, 'custom_build_directory': '/home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7_d357a1f7839b099012272bcb9853ec19', 'build_type': 'relwithdebinfo', 'abs_targets': ['/home/runner/actions_runner/_work/ydb/ydb'], 'debug_options': [], 'custom_conf': '/home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7/ymake.conf', 'continue_on_fail': False, 'ymake_bin': None, 'warn_mode': ['dirloops', 'ChkPeers'], 'build_depends': 3, 'arcadia_tests_data_path': '/home/runner/actions_runner/_work/ydb/arcadia_tests_data', 'checkout_data_by_ya': False, 'strict_inputs': False, 'dump_inputs_map': False, 'ev_listener': .event_listener_debug_id_wrapper at 0x7f31e36ba840>, 'enabled_events': 'dGT', 'no_caches_on_retry': False, 'no_ymake_retry': False, 'disable_customization': 0, 'dump_tests': '/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/test.dart', 'dump_make_files': '/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/makefiles.dart'} 2025-10-25 18:48:08,533 DEBUG (devtools.ya.core.yarg.behaviour) [ThreadPoolExecutor-0_0] Found unused args ['grab_stderr'] 2025-10-25 18:48:08,533 DEBUG (devtools.ya.build.prefetch) [ThreadPoolExecutor-0_0] prefetch disabled 2025-10-25 18:48:08,533 DEBUG (yalibrary.tools) [ThreadPoolExecutor-0_0] Using old-style toolchain for: ymake 2025-10-25 18:48:08,534 DEBUG (devtools.ya.build.ymake2.run_ymake) [ThreadPoolExecutor-0_0] run: '/home/runner/.ya/tools/v4/8069590186/ymake --depends-like-recurse --warn dirloops,ChkPeers --write-meta-data /home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmph6hk3eo8 --config /home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7/ymake.conf --plugins-root /home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins --build-root /home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7_d357a1f7839b099012272bcb9853ec19 --test-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/test.dart --tests-data-root /home/runner/actions_runner/_work/ydb/arcadia_tests_data --makefiles-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/makefiles.dart --dump-build-plan - --quiet --events dGT /home/runner/actions_runner/_work/ydb/ydb' with env: { } 2025-10-25 18:48:08,536 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"ymake run","_timestamp":1761418088536448,"_typename":"NEvent.TStageStarted","debug_id":"default-linux-x86_64-relwithdebinfo-pic","ymake_run_uid":0} 2025-10-25 18:48:08,537 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Target path: /home/runner/actions_runner/_work/ydb/ydb\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088536571,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,537 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Load configuration from cache","_timestamp":1761418088536594,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,537 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Conf cache has not been loaded (reason: File does not exist)...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088536607,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,537 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Load configuration from cache","_timestamp":1761418088536611,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,537 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedConfCache","Type":"bool","_timestamp":1761418088536891,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,537 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Load configuration (no cache)","_timestamp":1761418088536896,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,539 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"ymake run","_timestamp":1761418088539562,"_typename":"NEvent.TStageStarted","debug_id":"default-linux-x86_64-relwithdebinfo-nopic","ymake_run_uid":1} 2025-10-25 18:48:08,539 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Target path: /home/runner/actions_runner/_work/ydb/ydb\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088539664,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,540 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Load configuration from cache","_timestamp":1761418088539686,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,540 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Conf cache has not been loaded (reason: File does not exist)...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088539698,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,540 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Load configuration from cache","_timestamp":1761418088539702,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,540 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedConfCache","Type":"bool","_timestamp":1761418088539976,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,540 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Load configuration (no cache)","_timestamp":1761418088539981,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,696 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Load configuration (no cache)","_timestamp":1761418088695780,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,696 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Compile and RecalcAll conditions","_timestamp":1761418088695805,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,697 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Compile and RecalcAll conditions","_timestamp":1761418088697216,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,697 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Fold global commands","_timestamp":1761418088697228,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,698 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Fold global commands","_timestamp":1761418088698398,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,698 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Fill ModuleScopeOnly flag","_timestamp":1761418088698406,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,698 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Fill ModuleScopeOnly flag","_timestamp":1761418088698409,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,698 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Load plugins","_timestamp":1761418088698456,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,698 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Load configuration (no cache)","_timestamp":1761418088698667,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,699 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Compile and RecalcAll conditions","_timestamp":1761418088698683,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,700 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Compile and RecalcAll conditions","_timestamp":1761418088700050,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,700 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Fold global commands","_timestamp":1761418088700061,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,701 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Fold global commands","_timestamp":1761418088701214,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,701 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Fill ModuleScopeOnly flag","_timestamp":1761418088701221,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,701 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Fill ModuleScopeOnly flag","_timestamp":1761418088701224,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,701 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Load plugins","_timestamp":1761418088701267,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,815 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Load plugins","_timestamp":1761418088814988,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,817 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Load plugins","_timestamp":1761418088817377,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,846 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"MAIN_OUTPUT_AS_EXTRA enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088845916,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,846 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"YMAKE_DEDICATED_MODULE_NODE disabled (by default)\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088845938,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,846 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"YMAKE_CHECK_FOR_INCORRECT_LOOPS disabled (by default)\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088845943,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,848 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"MAIN_OUTPUT_AS_EXTRA enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088848332,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,848 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"YMAKE_DEDICATED_MODULE_NODE disabled (by default)\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088848353,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,849 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"YMAKE_CHECK_FOR_INCORRECT_LOOPS disabled (by default)\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088848358,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,861 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"ymake main","_timestamp":1761418088860923,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,861 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"FS cache loading is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861024,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,861 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"FS cache saving is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861030,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,861 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"ymake main","_timestamp":1761418088861427,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Deps cache loading is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861034,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"FS cache loading is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861494,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Deps cache saving is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861038,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"FS cache saving is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861499,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"DepManagement cache loading is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861041,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Deps cache loading is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861503,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"DepManagement cache saving is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861045,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Deps cache saving is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861506,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Uids cache loading is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861049,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,862 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"DepManagement cache loading is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861510,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Uids cache saving is enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088861052,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"DepManagement cache saving is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861514,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"HasChangelist":false,"_timestamp":1761418088862134,"_typename":"NEvent.TArcChanges","ymake_run_uid":0} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Uids cache loading is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861517,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Graph has structural changes because of PatchPath\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088862144,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Uids cache saving is enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088861520,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedFSCache","Type":"bool","_timestamp":1761418088862152,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"HasChangelist":false,"_timestamp":1761418088862588,"_typename":"NEvent.TArcChanges","ymake_run_uid":1} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedDepsCache","Type":"bool","_timestamp":1761418088862156,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Graph has structural changes because of PatchPath\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088862598,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,863 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Build graph","_timestamp":1761418088862162,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedFSCache","Type":"bool","_timestamp":1761418088862605,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"PredictsStructuralChanges":true,"_timestamp":1761418088862173,"_typename":"NEvent.TGraphChangesPrediction","ymake_run_uid":0} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedDepsCache","Type":"bool","_timestamp":1761418088862609,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Enabled":false,"MaybeEnabled":false,"_timestamp":1761418088862177,"_typename":"NEvent.TBypassConfigure","ymake_run_uid":0} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Build graph","_timestamp":1761418088862614,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Configure graph","_timestamp":1761418088862182,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"PredictsStructuralChanges":true,"_timestamp":1761418088862623,"_typename":"NEvent.TGraphChangesPrediction","ymake_run_uid":1} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Enabled":false,"MaybeEnabled":false,"_timestamp":1761418088862627,"_typename":"NEvent.TBypassConfigure","ymake_run_uid":1} 2025-10-25 18:48:08,864 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Configure graph","_timestamp":1761418088862631,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,908 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"DoubleValue":0.04571252974,"Name":"EYmakeStats::ConfigureGraphTime","Type":"double","_timestamp":1761418088907902,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,908 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Configure graph","_timestamp":1761418088907910,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,908 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Find Lost Includes","_timestamp":1761418088907943,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,908 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"DoubleValue":0.04565223766,"Name":"EYmakeStats::ConfigureGraphTime","Type":"double","_timestamp":1761418088908288,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,908 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Find Lost Includes","_timestamp":1761418088907955,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,909 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Configure graph","_timestamp":1761418088908296,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,909 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Find Lost Includes","_timestamp":1761418088908320,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,909 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"loaded size = 66; load time = 34; loaded MD5 time = 1; Max loaded MD5 time = 1; loaded count = 2; max load time = 30; mapped size = 0; mapped MD5 time = 0; Max mapped MD5 time = 0; mapped count = 0; map time = 0; from patch count = 0; from patch size = 0; file stat count = 2; lstat count = 2; lstat sum us = 22; lstat min us = 7; lstat avr us = 11; lstat max us = 15; opendir count = 0; opendir sum us = 0; opendir min us = 0; opendir avr us = 0; opendir max us = 0; readdir count = 0; readdir sum us = 0; readdir min us = 0; readdir avr us = 0; readdir max us = 0; (opendir + readdir) sum us = 0; (lstat + opendir + readdir) sum us = 22;","Mod":"unimp","Sub":"File access stats","Type":"Debug","_timestamp":1761418088907990,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,909 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Find Lost Includes","_timestamp":1761418088908330,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,909 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"FileStatCount":2,"FromPatchCount":0,"FromPatchSize":0,"ListDirSumUs":0,"LoadTime":34,"LoadedCount":2,"LoadedMD5Time":1,"LoadedSize":66,"LstatAvrUs":11,"LstatCount":2,"LstatListDirSumUs":22,"LstatMaxUs":15,"LstatMinUs":7,"LstatSumUs":22,"MapTime":0,"MappedCount":0,"MappedMD5Time":0,"MappedSize":0,"MaxLoadTime":30,"MaxLoadedMD5Time":1,"MaxMappedMD5Time":0,"OpendirAvrUs":0,"OpendirCount":0,"OpendirMaxUs":0,"OpendirMinUs":0,"OpendirSumUs":0,"ReaddirAvrUs":0,"ReaddirCount":0,"ReaddirMaxUs":0,"ReaddirMinUs":0,"ReaddirSumUs":0,"_timestamp":1761418088908004,"_typename":"NEvent.TFileConfStats","ymake_run_uid":0} 2025-10-25 18:48:08,909 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"loaded size = 66; load time = 24; loaded MD5 time = 0; Max loaded MD5 time = 0; loaded count = 2; max load time = 19; mapped size = 0; mapped MD5 time = 0; Max mapped MD5 time = 0; mapped count = 0; map time = 0; from patch count = 0; from patch size = 0; file stat count = 2; lstat count = 2; lstat sum us = 15; lstat min us = 5; lstat avr us = 7; lstat max us = 10; opendir count = 0; opendir sum us = 0; opendir min us = 0; opendir avr us = 0; opendir max us = 0; readdir count = 0; readdir sum us = 0; readdir min us = 0; readdir avr us = 0; readdir max us = 0; (opendir + readdir) sum us = 0; (lstat + opendir + readdir) sum us = 15;","Mod":"unimp","Sub":"File access stats","Type":"Debug","_timestamp":1761418088908362,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,909 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":66,"Name":"EFileConfStats::LoadedSize","Type":"int","_timestamp":1761418088908015,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":34,"Name":"EFileConfStats::LoadTime","Type":"int","_timestamp":1761418088908019,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"FileStatCount":2,"FromPatchCount":0,"FromPatchSize":0,"ListDirSumUs":0,"LoadTime":24,"LoadedCount":2,"LoadedMD5Time":0,"LoadedSize":66,"LstatAvrUs":7,"LstatCount":2,"LstatListDirSumUs":15,"LstatMaxUs":10,"LstatMinUs":5,"LstatSumUs":15,"MapTime":0,"MappedCount":0,"MappedMD5Time":0,"MappedSize":0,"MaxLoadTime":19,"MaxLoadedMD5Time":0,"MaxMappedMD5Time":0,"OpendirAvrUs":0,"OpendirCount":0,"OpendirMaxUs":0,"OpendirMinUs":0,"OpendirSumUs":0,"ReaddirAvrUs":0,"ReaddirCount":0,"ReaddirMaxUs":0,"ReaddirMinUs":0,"ReaddirSumUs":0,"_timestamp":1761418088908373,"_typename":"NEvent.TFileConfStats","ymake_run_uid":1} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":2,"Name":"EFileConfStats::LoadedCount","Type":"int","_timestamp":1761418088908022,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":66,"Name":"EFileConfStats::LoadedSize","Type":"int","_timestamp":1761418088908385,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":0,"Name":"EFileConfStats::MappedSize","Type":"int","_timestamp":1761418088908025,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":24,"Name":"EFileConfStats::LoadTime","Type":"int","_timestamp":1761418088908390,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":0,"Name":"EFileConfStats::MapTime","Type":"int","_timestamp":1761418088908028,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":2,"Name":"EFileConfStats::LoadedCount","Type":"int","_timestamp":1761418088908393,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":0,"Name":"EFileConfStats::MappedCount","Type":"int","_timestamp":1761418088908030,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,910 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":0,"Name":"EFileConfStats::MappedSize","Type":"int","_timestamp":1761418088908396,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":2,"Name":"EFileConfStats::Count","Type":"int","_timestamp":1761418088908033,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":0,"Name":"EFileConfStats::MapTime","Type":"int","_timestamp":1761418088908398,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"bucket id = 0; loaded size = 66; load time = 34; loaded count = 2; max load time = 30;","Mod":"unimp","Sub":"Bucket #0","Type":"Debug","_timestamp":1761418088908041,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":0,"Name":"EFileConfStats::MappedCount","Type":"int","_timestamp":1761418088908401,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"BucketId":0,"LoadTime":34,"LoadedCount":2,"LoadedSize":66,"MaxLoadTime":30,"_timestamp":1761418088908046,"_typename":"NEvent.TFileConfSubStats","ymake_run_uid":0} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":2,"Name":"EFileConfStats::Count","Type":"int","_timestamp":1761418088908404,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"parse time = 0; parsed files count = 0; parsed files size = 0; parsed files recovered = 0; .in files count = 0; .in files size = 0;","Mod":"unimp","Sub":"Parsing stats","Type":"Debug","_timestamp":1761418088908057,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"bucket id = 0; loaded size = 66; load time = 24; loaded count = 2; max load time = 19;","Mod":"unimp","Sub":"Bucket #0","Type":"Debug","_timestamp":1761418088908411,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,911 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"InFilesCount":0,"InFilesSize":0,"ParseTime":0,"ParsedFilesCount":0,"ParsedFilesRecovered":0,"ParsedFilesSize":0,"_timestamp":1761418088908062,"_typename":"NEvent.TIncParserManagerStats","ymake_run_uid":0} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"BucketId":0,"LoadTime":24,"LoadedCount":2,"LoadedSize":66,"MaxLoadTime":19,"_timestamp":1761418088908416,"_typename":"NEvent.TFileConfSubStats","ymake_run_uid":1} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"count = 1; includes count = 0; unique count = 1; size = 33; unique size = 33;","Mod":"unimp","Sub":"ya.make parsing stats","Type":"Debug","_timestamp":1761418088908072,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"parse time = 0; parsed files count = 0; parsed files size = 0; parsed files recovered = 0; .in files count = 0; .in files size = 0;","Mod":"unimp","Sub":"Parsing stats","Type":"Debug","_timestamp":1761418088908426,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Count":1,"Includes":0,"Size":33,"UniqueCount":1,"UniqueSize":33,"_timestamp":1761418088908076,"_typename":"NEvent.TGeneralParserStats","ymake_run_uid":0} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"InFilesCount":0,"InFilesSize":0,"ParseTime":0,"ParsedFilesCount":0,"ParsedFilesRecovered":0,"ParsedFilesSize":0,"_timestamp":1761418088908431,"_typename":"NEvent.TIncParserManagerStats","ymake_run_uid":1} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"nodes count = 2; edges count = 1; files count = 6; commands count = 16;","Mod":"unimp","Sub":"DepGraph stats","Type":"Debug","_timestamp":1761418088908083,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"count = 1; includes count = 0; unique count = 1; size = 33; unique size = 33;","Mod":"unimp","Sub":"ya.make parsing stats","Type":"Debug","_timestamp":1761418088908440,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"CommandsCount":16,"EdgesCount":1,"FilesCount":6,"NodesCount":2,"_timestamp":1761418088908090,"_typename":"NEvent.TDepGraphStats","ymake_run_uid":0} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Count":1,"Includes":0,"Size":33,"UniqueCount":1,"UniqueSize":33,"_timestamp":1761418088908444,"_typename":"NEvent.TGeneralParserStats","ymake_run_uid":1} 2025-10-25 18:48:08,912 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"nuke mod dir = 0;","Mod":"unimp","Sub":"UpdIter stats","Type":"Debug","_timestamp":1761418088908096,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"nodes count = 2; edges count = 1; files count = 6; commands count = 16;","Mod":"unimp","Sub":"DepGraph stats","Type":"Debug","_timestamp":1761418088908452,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"NukedDir":0,"_timestamp":1761418088908099,"_typename":"NEvent.TUpdIterStats","ymake_run_uid":0} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"CommandsCount":16,"EdgesCount":1,"FilesCount":6,"NodesCount":2,"_timestamp":1761418088908459,"_typename":"NEvent.TDepGraphStats","ymake_run_uid":1} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Includes attempts = 0; From cache = 0; Resolve AsKnown total = 0; Resolve AsKnown from cache = 0;","Mod":"unimp","Sub":"Resolving stats","Type":"Debug","_timestamp":1761418088908106,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"nuke mod dir = 0;","Mod":"unimp","Sub":"UpdIter stats","Type":"Debug","_timestamp":1761418088908464,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IncludesAttempted":0,"IncludesFromCache":0,"ResolveAsKnownFromCache":0,"ResolveAsKnownTotal":0,"_timestamp":1761418088908110,"_typename":"NEvent.TResolveStats","ymake_run_uid":0} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"NukedDir":0,"_timestamp":1761418088908467,"_typename":"NEvent.TUpdIterStats","ymake_run_uid":1} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Build graph","_timestamp":1761418088908114,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Includes attempts = 0; From cache = 0; Resolve AsKnown total = 0; Resolve AsKnown from cache = 0;","Mod":"unimp","Sub":"Resolving stats","Type":"Debug","_timestamp":1761418088908474,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"accessed = 0; loaded = 0; outdated = 0; parsed = 0; total = 0;","Mod":"unimp","Sub":"TModules stats","Type":"Debug","_timestamp":1761418088908125,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,913 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IncludesAttempted":0,"IncludesFromCache":0,"ResolveAsKnownFromCache":0,"ResolveAsKnownTotal":0,"_timestamp":1761418088908478,"_typename":"NEvent.TResolveStats","ymake_run_uid":1} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Accessed":0,"Loaded":0,"Outdated":0,"Parsed":0,"Total":0,"_timestamp":1761418088908129,"_typename":"NEvent.TModulesStats","ymake_run_uid":0} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Build graph","_timestamp":1761418088908481,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":0,"Name":"EModulesStats::Accessed","Type":"int","_timestamp":1761418088908133,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"accessed = 0; loaded = 0; outdated = 0; parsed = 0; total = 0;","Mod":"unimp","Sub":"TModules stats","Type":"Debug","_timestamp":1761418088908491,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":0,"Name":"EModulesStats::Loaded","Type":"int","_timestamp":1761418088908135,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Accessed":0,"Loaded":0,"Outdated":0,"Parsed":0,"Total":0,"_timestamp":1761418088908495,"_typename":"NEvent.TModulesStats","ymake_run_uid":1} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":0,"Name":"EModulesStats::Outdated","Type":"int","_timestamp":1761418088908138,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":0,"Name":"EModulesStats::Accessed","Type":"int","_timestamp":1761418088908498,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"IntValue":0,"Name":"EModulesStats::Parsed","Type":"int","_timestamp":1761418088908140,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":0,"Name":"EModulesStats::Loaded","Type":"int","_timestamp":1761418088908501,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,914 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":0,"Name":"EModulesStats::Outdated","Type":"int","_timestamp":1761418088908504,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"IntValue":0,"Name":"EModulesStats::Parsed","Type":"int","_timestamp":1761418088908506,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Set reachable nodes","_timestamp":1761418088908149,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Set reachable nodes","_timestamp":1761418088908154,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Sort edges","_timestamp":1761418088908156,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Set reachable nodes","_timestamp":1761418088908514,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Sort edges","_timestamp":1761418088908159,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Set reachable nodes","_timestamp":1761418088908517,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Report Foreign Platform Events","_timestamp":1761418088908161,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Sort edges","_timestamp":1761418088908519,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"_timestamp":1761418088908163,"_typename":"NEvent.TAllForeignPlatformsReported","ymake_run_uid":0} 2025-10-25 18:48:08,915 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Sort edges","_timestamp":1761418088908521,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,916 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Report Foreign Platform Events","_timestamp":1761418088908166,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,916 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Report Foreign Platform Events","_timestamp":1761418088908523,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,916 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Check blacklist","_timestamp":1761418088908168,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,916 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"_timestamp":1761418088908526,"_typename":"NEvent.TAllForeignPlatformsReported","ymake_run_uid":1} 2025-10-25 18:48:08,916 DEBUG (_ToolTargetsQueue) [MainThread] Source_id=1 (default-linux-x86_64-relwithdebinfo-pic). Tool targets: set() 2025-10-25 18:48:08,916 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Check blacklist","_timestamp":1761418088908171,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,916 DEBUG (_ToolTargetsQueue) [MainThread] Source_id=0 (default-linux-x86_64-relwithdebinfo-nopic). Tool targets: set() 2025-10-25 18:48:08,916 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Report Foreign Platform Events","_timestamp":1761418088908528,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,916 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=waiting-tool-targets, group=graph, time=1761418088.9168866 2025-10-25 18:48:08,917 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Check isolated projects","_timestamp":1761418088908173,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,917 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage waiting-tool-targets_finished=1761418088.9168866 2025-10-25 18:48:08,917 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Check blacklist","_timestamp":1761418088908530,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,917 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step waiting-tool-targets_finished - 1761418088.9168866 2025-10-25 18:48:08,917 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Check isolated projects","_timestamp":1761418088908176,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,917 DEBUG (devtools.ya.build.graph) [MainThread] Empty tool targets list 2025-10-25 18:48:08,917 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Check blacklist","_timestamp":1761418088908532,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,917 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=get-tools, group=graph, time=1761418088.917674 2025-10-25 18:48:08,917 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Compact internal graph and modules table","_timestamp":1761418088908179,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,917 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage get-tools_finished=1761418088.917674 2025-10-25 18:48:08,917 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Check isolated projects","_timestamp":1761418088908534,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,917 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step get-tools_finished - 1761418088.917674 2025-10-25 18:48:08,918 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Compact internal graph and modules table","_timestamp":1761418088908182,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,918 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=merge-target-graphs-1, group=graph, time=1761418088.9181983 2025-10-25 18:48:08,918 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Check isolated projects","_timestamp":1761418088908537,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,918 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage merge-target-graphs-1_started=1761418088.9181983 2025-10-25 18:48:08,918 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step merge-target-graphs-1_started - 1761418088.9181983 2025-10-25 18:48:08,918 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=wait-target-graphs-1, group=graph, time=1761418088.9185708 2025-10-25 18:48:08,918 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage wait-target-graphs-1_started=1761418088.9185708 2025-10-25 18:48:08,918 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Detect loops","_timestamp":1761418088908185,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,918 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step wait-target-graphs-1_started - 1761418088.9185708 2025-10-25 18:48:08,918 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Compact internal graph and modules table","_timestamp":1761418088908539,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"HasContentChanges":true,"HasStructuralChanges":true,"_timestamp":1761418088908192,"_typename":"NEvent.TGraphChanges","ymake_run_uid":0} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Compact internal graph and modules table","_timestamp":1761418088908542,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Detect loops","_timestamp":1761418088908195,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Detect loops","_timestamp":1761418088908544,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Apply Dependency Management","_timestamp":1761418088908197,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"HasContentChanges":true,"HasStructuralChanges":true,"_timestamp":1761418088908550,"_typename":"NEvent.TGraphChanges","ymake_run_uid":1} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Apply Dependency Management","_timestamp":1761418088908203,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Detect loops","_timestamp":1761418088908552,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Compute DEPENDS to modules closure","_timestamp":1761418088908205,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Apply Dependency Management","_timestamp":1761418088908555,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Compute DEPENDS to modules closure","_timestamp":1761418088908207,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Apply Dependency Management","_timestamp":1761418088908561,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,919 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Save Dependency management cache","_timestamp":1761418088908210,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Compute DEPENDS to modules closure","_timestamp":1761418088908563,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Save Dependency management cache","_timestamp":1761418088908713,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Compute DEPENDS to modules closure","_timestamp":1761418088908565,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Check Transitive Requirements","_timestamp":1761418088908723,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Save Dependency management cache","_timestamp":1761418088908568,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Check Transitive Requirements","_timestamp":1761418088908728,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Save Dependency management cache","_timestamp":1761418088908869,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Find missing peerdirs","_timestamp":1761418088908732,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Check Transitive Requirements","_timestamp":1761418088908877,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Find missing peerdirs","_timestamp":1761418088908734,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Check Transitive Requirements","_timestamp":1761418088908881,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,920 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Report Configure Events","_timestamp":1761418088908738,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Find missing peerdirs","_timestamp":1761418088908883,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Searching target '.'\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088907918,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Find missing peerdirs","_timestamp":1761418088908886,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Selected target '$S' with id 2\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088907925,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Report Configure Events","_timestamp":1761418088908888,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"TIncFixer stats: 0 resolved to nothing, 0 resolved to existing, 0 resolved to new.\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088907952,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Searching target '.'\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088908302,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"DM cache has been saved...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088908707,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Selected target '$S' with id 2\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088908308,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Modules requiring dependency management: 0; BFS traversals performed: 0\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088908718,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,921 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"TIncFixer stats: 0 resolved to nothing, 0 resolved to existing, 0 resolved to new.\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088908327,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Report Configure Events","_timestamp":1761418088908745,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"DM cache has been saved...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088908865,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Save Deps cache","_timestamp":1761418088908751,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Modules requiring dependency management: 0; BFS traversals performed: 0\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088908873,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Total cache size on save = 2912; Diagnostics cache size on save = 1104; Graph cache size on save = 112; Parsers cache size on save = 144; Modules table size on save = 4; Times table size on save = 16; Names table size on save = 816; Commands cache size on save = 272;","Mod":"unimp","Sub":"Internal cache stats","Type":"Debug","_timestamp":1761418088908787,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Report Configure Events","_timestamp":1761418088908894,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"CommandsSize":272,"DiagnosticsCacheSize":1104,"GraphCacheSize":112,"ModulesTableSize":4,"NamesTableSize":816,"ParsersCacheSize":144,"TimesTableSize":16,"TotalCacheSize":2912,"_timestamp":1761418088908794,"_typename":"NEvent.TInternalCacheSaverStats","ymake_run_uid":0} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Save Deps cache","_timestamp":1761418088908900,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"FS cache has been saved...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088908801,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Total cache size on save = 2912; Diagnostics cache size on save = 1104; Graph cache size on save = 112; Parsers cache size on save = 144; Modules table size on save = 4; Times table size on save = 16; Names table size on save = 816; Commands cache size on save = 272;","Mod":"unimp","Sub":"Internal cache stats","Type":"Debug","_timestamp":1761418088908928,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,922 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Deps cache has been saved...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088908805,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"CommandsSize":272,"DiagnosticsCacheSize":1104,"GraphCacheSize":112,"ModulesTableSize":4,"NamesTableSize":816,"ParsersCacheSize":144,"TimesTableSize":16,"TotalCacheSize":2912,"_timestamp":1761418088908934,"_typename":"NEvent.TInternalCacheSaverStats","ymake_run_uid":1} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Save Deps cache","_timestamp":1761418088909509,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"FS cache has been saved...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088908941,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Export JSON","_timestamp":1761418088909515,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Deps cache has been saved...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088908945,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Write JSON","_timestamp":1761418088909520,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Save Deps cache","_timestamp":1761418088909689,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Exporting JSON\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088909524,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Export JSON","_timestamp":1761418088909695,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Visit JSON","_timestamp":1761418088909527,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Write JSON","_timestamp":1761418088909699,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,923 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Visit JSON","_timestamp":1761418088909541,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Exporting JSON\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088909702,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Render JSON","_timestamp":1761418088909544,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Visit JSON","_timestamp":1761418088909706,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Visit JSON","_timestamp":1761418088909714,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Store inputs in JSON cache: enabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088909553,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Render JSON","_timestamp":1761418088909717,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Store inputs in JSON cache: enabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088909724,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Loaded cache items = 0; Added cache items = 0; Saved old cache items = 0; Saved new cache items = 0; Saved total cache items = 0; Loaded full match items = 0; Full match requests = 0; Successful full matches = 0; Loaded partial match items = 0; Partial match requests = 0; Successful partial matches = 0; Fully rendered nodes = 0; Partially rendered nodes = 0; Nodes restored without rendering = 0;","Mod":"unimp","Sub":"JSON cache stats","Type":"Debug","_timestamp":1761418088909577,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,924 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"AddedItems":0,"FullMatchLoadedItems":0,"FullMatchRequests":0,"FullMatchSuccess":0,"FullyRendered":0,"LoadedItems":0,"NewItemsSaved":0,"NoRendered":0,"OldItemsSaved":0,"PartialMatchLoadedItems":0,"PartialMatchRequests":0,"PartialMatchSuccess":0,"PartiallyRendered":0,"TotalItemsSaved":0,"_timestamp":1761418088909585,"_typename":"NEvent.TJsonCacheStats","ymake_run_uid":0} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Loaded cache items = 0; Added cache items = 0; Saved old cache items = 0; Saved new cache items = 0; Saved total cache items = 0; Loaded full match items = 0; Full match requests = 0; Successful full matches = 0; Loaded partial match items = 0; Partial match requests = 0; Successful partial matches = 0; Fully rendered nodes = 0; Partially rendered nodes = 0; Nodes restored without rendering = 0;","Mod":"unimp","Sub":"JSON cache stats","Type":"Debug","_timestamp":1761418088909743,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"JSON cache report: disabled\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088909592,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"AddedItems":0,"FullMatchLoadedItems":0,"FullMatchRequests":0,"FullMatchSuccess":0,"FullyRendered":0,"LoadedItems":0,"NewItemsSaved":0,"NoRendered":0,"OldItemsSaved":0,"PartialMatchLoadedItems":0,"PartialMatchRequests":0,"PartialMatchSuccess":0,"PartiallyRendered":0,"TotalItemsSaved":0,"_timestamp":1761418088909751,"_typename":"NEvent.TJsonCacheStats","ymake_run_uid":1} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"DoubleValue":0.00005065783568,"Name":"EYmakeStats::RenderJSONTime","Type":"double","_timestamp":1761418088909598,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"JSON cache report: disabled\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088909758,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Render JSON","_timestamp":1761418088909602,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"DoubleValue":0.0000429291265,"Name":"EYmakeStats::RenderJSONTime","Type":"double","_timestamp":1761418088909762,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Save Uids cache","_timestamp":1761418088909604,"_typename":"NEvent.TStageStarted","ymake_run_uid":0} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Render JSON","_timestamp":1761418088909766,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Uids cache has been saved...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088909624,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,925 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Save Uids cache","_timestamp":1761418088909768,"_typename":"NEvent.TStageStarted","ymake_run_uid":1} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Save Uids cache","_timestamp":1761418088909627,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Uids cache has been saved...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088909785,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"HasRenderedNodeChanges":true,"_timestamp":1761418088909637,"_typename":"NEvent.TNodeChanges","ymake_run_uid":0} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Save Uids cache","_timestamp":1761418088909788,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Loaded nodes = 0; Skipped nodes = 0; Discarded nodes = 0; Loaded loops = 0; Skipped loops = 0; Discarded loops = 0; Saved nodes = 2; Saved loops = 0; Really all nodes no rendered = 0;","Mod":"unimp","Sub":"Uids cache stats","Type":"Debug","_timestamp":1761418088909649,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"HasRenderedNodeChanges":true,"_timestamp":1761418088909797,"_typename":"NEvent.TNodeChanges","ymake_run_uid":1} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"DiscardedLoops":0,"DiscardedNodes":0,"LoadedLoops":0,"LoadedNodes":0,"SavedLoops":0,"SavedNodes":2,"SkippedLoops":0,"SkippedNodes":0,"_timestamp":1761418088909654,"_typename":"NEvent.TUidsCacheStats","ymake_run_uid":0} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Loaded nodes = 0; Skipped nodes = 0; Discarded nodes = 0; Loaded loops = 0; Skipped loops = 0; Discarded loops = 0; Saved nodes = 2; Saved loops = 0; Really all nodes no rendered = 0;","Mod":"unimp","Sub":"Uids cache stats","Type":"Debug","_timestamp":1761418088909808,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"DoubleValue":0.0001471501923,"Name":"EYmakeStats::WriteJSONTime","Type":"double","_timestamp":1761418088909670,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,926 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"DiscardedLoops":0,"DiscardedNodes":0,"LoadedLoops":0,"LoadedNodes":0,"SavedLoops":0,"SavedNodes":2,"SkippedLoops":0,"SkippedNodes":0,"_timestamp":1761418088909813,"_typename":"NEvent.TUidsCacheStats","ymake_run_uid":1} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Write JSON","_timestamp":1761418088909673,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"DoubleValue":0.000126550057,"Name":"EYmakeStats::WriteJSONTime","Type":"double","_timestamp":1761418088909828,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"Export JSON","_timestamp":1761418088909676,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Write JSON","_timestamp":1761418088909831,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedUidsCache","Type":"bool","_timestamp":1761418088909678,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"Export JSON","_timestamp":1761418088909834,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"module environment initialization calls = 0; actual module environment initializations = 0;","Mod":"unimp","Sub":"TMakeCommand stats","Type":"Debug","_timestamp":1761418088909686,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"BoolValue":false,"Name":"EYmakeStats::UsedUidsCache","Type":"bool","_timestamp":1761418088909837,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"InitModuleEnv":0,"InitModuleEnvCalls":0,"_timestamp":1761418088909690,"_typename":"NEvent.TMakeCommandStats","ymake_run_uid":0} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"module environment initialization calls = 0; actual module environment initializations = 0;","Mod":"unimp","Sub":"TMakeCommand stats","Type":"Debug","_timestamp":1761418088909844,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"FS cache has been committed...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088911732,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"InitModuleEnv":0,"InitModuleEnvCalls":0,"_timestamp":1761418088909847,"_typename":"NEvent.TMakeCommandStats","ymake_run_uid":1} 2025-10-25 18:48:08,927 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Deps cache has been committed...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088911738,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"FS cache has been committed...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088912336,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"_timestamp":1761418088911742,"_typename":"NEvent.TReadyForUpdateCacheInfo","ymake_run_uid":0} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Deps cache has been committed...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088912343,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"DM cache has been committed...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088911752,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"_timestamp":1761418088912346,"_typename":"NEvent.TReadyForUpdateCacheInfo","ymake_run_uid":1} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Uids cache has been committed...\n","Mod":"unimp","PID":3128,"Sub":"","Type":"Debug","_timestamp":1761418088911762,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"DM cache has been committed...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088912356,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"Message":"Maximum stack size in TUpdIter = 2; Maximum stack size in TUpdReiter = 0; Maximum stack size in TJSONVisitor = 2;","Mod":"unimp","Sub":"StackDepthStats","Type":"Debug","_timestamp":1761418088911771,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":0} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Uids cache has been committed...\n","Mod":"unimp","PID":3130,"Sub":"","Type":"Debug","_timestamp":1761418088912366,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"ymake main","_timestamp":1761418088912323,"_typename":"NEvent.TStageFinished","ymake_run_uid":0} 2025-10-25 18:48:08,928 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"Message":"Maximum stack size in TUpdIter = 2; Maximum stack size in TUpdReiter = 0; Maximum stack size in TJSONVisitor = 2;","Mod":"unimp","Sub":"StackDepthStats","Type":"Debug","_timestamp":1761418088912375,"_typename":"NEvent.TDisplayMessage","ymake_run_uid":1} 2025-10-25 18:48:08,929 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"DoubleValue":0.3758677293,"Name":"EYmakeStats::RunTime","Type":"double","_timestamp":1761418088912346,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":0} 2025-10-25 18:48:08,929 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"ymake main","_timestamp":1761418088912903,"_typename":"NEvent.TStageFinished","ymake_run_uid":1} 2025-10-25 18:48:08,929 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_1] Configure message {"StageName":"ymake run","_timestamp":1761418088912350,"_typename":"NEvent.TStageFinished","debug_id":"default-linux-x86_64-relwithdebinfo-pic","ymake_run_uid":0} 2025-10-25 18:48:08,929 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"DoubleValue":0.3733521082,"Name":"EYmakeStats::RunTime","Type":"double","_timestamp":1761418088912928,"_typename":"NEvent.TMonitoringStat","ymake_run_uid":1} 2025-10-25 18:48:08,929 DEBUG (devtools.ya.build.ya_make) [ThreadPoolExecutor-0_0] Configure message {"StageName":"ymake run","_timestamp":1761418088912932,"_typename":"NEvent.TStageFinished","debug_id":"default-linux-x86_64-relwithdebinfo-nopic","ymake_run_uid":1} 2025-10-25 18:48:08,929 DEBUG (devtools.ya.build.ymake2.run_ymake) [ThreadPoolExecutor-0_1] run '/home/runner/.ya/tools/v4/8069590186/ymake --depends-like-recurse --warn dirloops,ChkPeers --write-meta-data /home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmp6gyy3_ev --config /home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a/ymake.conf --plugins-root /home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins --build-root /home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a_d357a1f7839b099012272bcb9853ec19 --test-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/test.dart --tests-data-root /home/runner/actions_runner/_work/ydb/arcadia_tests_data --makefiles-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/makefiles.dart --dump-build-plan - --quiet --events dGT /home/runner/actions_runner/_work/ydb/ydb' finished 2025-10-25 18:48:08,929 DEBUG (devtools.ya.build.ymake2.run_ymake) [ThreadPoolExecutor-0_0] run '/home/runner/.ya/tools/v4/8069590186/ymake --depends-like-recurse --warn dirloops,ChkPeers --write-meta-data /home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmph6hk3eo8 --config /home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7/ymake.conf --plugins-root /home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins --build-root /home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7_d357a1f7839b099012272bcb9853ec19 --test-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/test.dart --tests-data-root /home/runner/actions_runner/_work/ydb/arcadia_tests_data --makefiles-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/makefiles.dart --dump-build-plan - --quiet --events dGT /home/runner/actions_runner/_work/ydb/ydb' finished 2025-10-25 18:48:08,930 DEBUG (devtools.ya.core.event_handling.base_subscriber) [ThreadPoolExecutor-0_1] Unsubscribing PrintProgressSubscriber from event_queue 2025-10-25 18:48:08,930 DEBUG (devtools.ya.build.ymake2) [ThreadPoolExecutor-0_0] ymake_run_info: {"ymake_run_uid":1,"stats":{"preparing":{"start":1761418088.533446311950684,"finish":1761418088.534033298492432,"duration":0.000586986541748},"execution":{"start":1761418088.534034252166748,"finish":1761418088.929704427719116,"duration":0.395670175552368},"postprocessing":{"start":1761418088.929705619812012,"finish":1761418088.929926156997681,"duration":0.000220537185669}},"purpose":"default-linux-x86_64-relwithdebinfo-nopic","caches":{"FS cache":{"loaded":false,"saved":true,"loading_enabled":true,"saving_enabled":true,"committed":true},"Deps cache":{"loaded":false,"saved":true,"loading_enabled":true,"saving_enabled":true,"committed":true},"DepManagement cache":{"loaded":false,"saved":false,"loading_enabled":true,"saving_enabled":true},"Uids cache":{"loaded":false,"saved":true,"loading_enabled":true,"saving_enabled":true,"committed":true},"DM cache":{"loaded":false,"saved":true,"loading_enabled":false,"saving_enabled":false,"committed":true}},"stages":{"ymake run":{"start":1761418088.539561986923218,"finish":1761418088.9129319190979,"duration":0.373369932174683},"Load configuration from cache":{"start":1761418088.539685964584351,"finish":1761418088.53970193862915,"duration":0.0000159740448},"Load configuration (no cache)":{"start":1761418088.539980888366699,"finish":1761418088.698667049407959,"duration":0.15868616104126},"Compile and RecalcAll conditions":{"start":1761418088.698683023452759,"finish":1761418088.700050115585327,"duration":0.001367092132568},"Fold global commands":{"start":1761418088.700061082839966,"finish":1761418088.701214075088501,"duration":0.001152992248535},"Fill ModuleScopeOnly flag":{"start":1761418088.701220989227295,"finish":1761418088.701224088668823,"duration":0.000003099441528},"Load plugins":{"start":1761418088.701267004013062,"finish":1761418088.817377090454102,"duration":0.11611008644104},"ymake main":{"start":1761418088.861427068710327,"finish":1761418088.912903070449829,"duration":0.051476001739502},"Build graph":{"start":1761418088.862613916397095,"finish":1761418088.908480882644653,"duration":0.045866966247559},"Configure graph":{"start":1761418088.86263108253479,"finish":1761418088.90829610824585,"duration":0.04566502571106},"Find Lost Includes":{"start":1761418088.90831995010376,"finish":1761418088.908329963684082,"duration":0.000010013580322},"Set reachable nodes":{"start":1761418088.908514022827148,"finish":1761418088.908516883850098,"duration":0.000002861022949},"Sort edges":{"start":1761418088.90851902961731,"finish":1761418088.908520936965942,"duration":0.000001907348633},"Report Foreign Platform Events":{"start":1761418088.908523082733154,"finish":1761418088.908528089523315,"duration":0.000005006790161},"Check blacklist":{"start":1761418088.908529996871948,"finish":1761418088.908531904220581,"duration":0.000001907348633},"Check isolated projects":{"start":1761418088.908534049987793,"finish":1761418088.908536911010742,"duration":0.000002861022949},"Compact internal graph and modules table":{"start":1761418088.908539056777954,"finish":1761418088.908541917800903,"duration":0.000002861022949},"Detect loops":{"start":1761418088.908544063568115,"finish":1761418088.908551931381226,"duration":0.00000786781311},"Apply Dependency Management":{"start":1761418088.908555030822754,"finish":1761418088.908560991287232,"duration":0.000005960464478},"Compute DEPENDS to modules closure":{"start":1761418088.908562898635864,"finish":1761418088.908565044403076,"duration":0.000002145767212},"Save Dependency management cache":{"start":1761418088.908567905426025,"finish":1761418088.908869028091431,"duration":0.000301122665405},"Check Transitive Requirements":{"start":1761418088.908876895904541,"finish":1761418088.908880949020386,"duration":0.000004053115845},"Find missing peerdirs":{"start":1761418088.908883094787598,"finish":1761418088.908885955810547,"duration":0.000002861022949},"Report Configure Events":{"start":1761418088.908888101577759,"finish":1761418088.908894062042236,"duration":0.000005960464478},"Save Deps cache":{"start":1761418088.908900022506714,"finish":1761418088.909688949584961,"duration":0.000788927078247},"Export JSON":{"start":1761418088.909694910049438,"finish":1761418088.909833908081055,"duration":0.000138998031616},"Write JSON":{"start":1761418088.909698963165283,"finish":1761418088.909831047058106,"duration":0.000132083892822},"Visit JSON":{"start":1761418088.909706115722656,"finish":1761418088.909713983535767,"duration":0.00000786781311},"Render JSON":{"start":1761418088.909717082977295,"finish":1761418088.909765958786011,"duration":0.000048875808716},"Save Uids cache":{"start":1761418088.909768104553223,"finish":1761418088.909787893295288,"duration":0.000019788742065}},"metrics":{"File access":{"loaded size":66,"load time":24,"loaded MD5 time":0,"Max loaded MD5 time":0,"loaded count":2,"max load time":19,"mapped size":0,"mapped MD5 time":0,"Max mapped MD5 time":0,"mapped count":0,"map time":0,"from patch count":0,"from patch size":0,"file stat count":2,"lstat count":2,"lstat sum us":15,"lstat min us":5,"lstat avr us":7,"lstat max us":10,"opendir count":0,"opendir sum us":0,"opendir min us":0,"opendir avr us":0,"opendir max us":0,"readdir count":0,"readdir sum us":0,"readdir min us":0,"readdir avr us":0,"readdir max us":0,"(opendir + readdir) sum us":0,"(lstat + opendir + readdir) sum us":15},"Parsing":{"parse time":0,"parsed files count":0,"parsed files size":0,"parsed files recovered":0,".in files count":0,".in files size":0},"ya.make parsing":{"count":1,"includes count":0,"unique count":1,"size":33,"unique size":33},"DepGraph":{"nodes count":2,"edges count":1,"files count":6,"commands count":16},"UpdIter":{"nuke mod dir":0},"Resolving":{"Includes attempts":0,"From cache":0,"Resolve AsKnown total":0,"Resolve AsKnown from cache":0},"TModules":{"accessed":0,"loaded":0,"outdated":0,"parsed":0,"total":0},"Internal cache":{"Total cache size on save":2912,"Diagnostics cache size on save":1104,"Graph cache size on save":112,"Parsers cache size on save":144,"Modules table size on save":4,"Times table size on save":16,"Names table size on save":816,"Commands cache size on save":272},"JSON cache":{"Loaded cache items":0,"Added cache items":0,"Saved old cache items":0,"Saved new cache items":0,"Saved total cache items":0,"Loaded full match items":0,"Full match requests":0,"Successful full matches":0,"Loaded partial match items":0,"Partial match requests":0,"Successful partial matches":0,"Fully rendered nodes":0,"Partially rendered nodes":0,"Nodes restored without rendering":0},"Uids cache":{"Loaded nodes":0,"Skipped nodes":0,"Discarded nodes":0,"Loaded loops":0,"Skipped loops":0,"Discarded loops":0,"Saved nodes":2,"Saved loops":0,"Really all nodes no rendered":0},"TMakeCommand":{"module environment initialization calls":0,"actual module environment initializations":0}},"binary":"/home/runner/.ya/tools/v4/8069590186/ymake","args":["/home/runner/.ya/tools/v4/8069590186/ymake","--depends-like-recurse","--warn","dirloops,ChkPeers","--write-meta-data","/home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmph6hk3eo8","--config","/home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7/ymake.conf","--plugins-root","/home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins","--build-root","/home/runner/.ya/build/conf/dist-relwithdebinfo-x-625a76025eba31525eb2cbb47883b5f7_d357a1f7839b099012272bcb9853ec19","--test-dart","/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/test.dart","--tests-data-root","/home/runner/actions_runner/_work/ydb/arcadia_tests_data","--makefiles-dart","/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.ky0jn6hh/makefiles.dart","--dump-build-plan","-","--quiet","--events","dGT","/home/runner/actions_runner/_work/ydb/ydb"],"has_changelist":false,"predicts_structural_changes":true,"bypass_is_enabled":false,"bypass_is_triggered":false,"has_content_changes":true,"has_structural_changes":true,"has_rendered_node_changes":true,"exit_code":0,"duration":0.395670175552368} 2025-10-25 18:48:08,931 DEBUG (devtools.ya.build.ymake2) [ThreadPoolExecutor-0_1] ymake_run_info: {"ymake_run_uid":0,"stats":{"preparing":{"start":1761418088.528704404830933,"finish":1761418088.529370307922363,"duration":0.000665903091431},"execution":{"start":1761418088.529371500015259,"finish":1761418088.929635047912598,"duration":0.400263547897339},"postprocessing":{"start":1761418088.929637908935547,"finish":1761418088.930633544921875,"duration":0.000995635986328}},"purpose":"default-linux-x86_64-relwithdebinfo-pic","caches":{"FS cache":{"loaded":false,"saved":true,"loading_enabled":true,"saving_enabled":true,"committed":true},"Deps cache":{"loaded":false,"saved":true,"loading_enabled":true,"saving_enabled":true,"committed":true},"DepManagement cache":{"loaded":false,"saved":false,"loading_enabled":true,"saving_enabled":true},"Uids cache":{"loaded":false,"saved":true,"loading_enabled":true,"saving_enabled":true,"committed":true},"DM cache":{"loaded":false,"saved":true,"loading_enabled":false,"saving_enabled":false,"committed":true}},"stages":{"ymake run":{"start":1761418088.536448001861572,"finish":1761418088.912349939346314,"duration":0.375901937484741},"Load configuration from cache":{"start":1761418088.536593914031982,"finish":1761418088.536611080169678,"duration":0.000017166137695},"Load configuration (no cache)":{"start":1761418088.536895990371704,"finish":1761418088.695780038833618,"duration":0.158884048461914},"Compile and RecalcAll conditions":{"start":1761418088.695805072784424,"finish":1761418088.697216033935547,"duration":0.001410961151123},"Fold global commands":{"start":1761418088.697227954864502,"finish":1761418088.698398113250732,"duration":0.00117015838623},"Fill ModuleScopeOnly flag":{"start":1761418088.698405981063843,"finish":1761418088.698409080505371,"duration":0.000003099441528},"Load plugins":{"start":1761418088.698456048965454,"finish":1761418088.814987897872925,"duration":0.116531848907471},"ymake main":{"start":1761418088.860923051834106,"finish":1761418088.912322998046875,"duration":0.051399946212769},"Build graph":{"start":1761418088.862162113189697,"finish":1761418088.908113956451416,"duration":0.045951843261719},"Configure graph":{"start":1761418088.862181901931763,"finish":1761418088.907910108566284,"duration":0.045728206634521},"Find Lost Includes":{"start":1761418088.9079430103302,"finish":1761418088.907954931259155,"duration":0.000011920928955},"Set reachable nodes":{"start":1761418088.908149003982544,"finish":1761418088.908154010772705,"duration":0.000005006790161},"Sort edges":{"start":1761418088.908155918121338,"finish":1761418088.908159017562866,"duration":0.000003099441528},"Report Foreign Platform Events":{"start":1761418088.908160924911499,"finish":1761418088.90816593170166,"duration":0.000005006790161},"Check blacklist":{"start":1761418088.908168077468872,"finish":1761418088.908170938491821,"duration":0.000002861022949},"Check isolated projects":{"start":1761418088.908173084259033,"finish":1761418088.908175945281982,"duration":0.000002861022949},"Compact internal graph and modules table":{"start":1761418088.908179044723511,"finish":1761418088.90818190574646,"duration":0.000002861022949},"Detect loops":{"start":1761418088.908185005187988,"finish":1761418088.90819501876831,"duration":0.000010013580322},"Apply Dependency Management":{"start":1761418088.908196926116943,"finish":1761418088.908202886581421,"duration":0.000005960464478},"Compute DEPENDS to modules closure":{"start":1761418088.908205032348633,"finish":1761418088.908206939697266,"duration":0.000001907348633},"Save Dependency management cache":{"start":1761418088.908210039138794,"finish":1761418088.908713102340698,"duration":0.000503063201904},"Check Transitive Requirements":{"start":1761418088.90872311592102,"finish":1761418088.908727884292602,"duration":0.000004768371582},"Find missing peerdirs":{"start":1761418088.908731937408447,"finish":1761418088.908734083175659,"duration":0.000002145767212},"Report Configure Events":{"start":1761418088.908737897872925,"finish":1761418088.908745050430298,"duration":0.000007152557373},"Save Deps cache":{"start":1761418088.908751010894775,"finish":1761418088.909508943557739,"duration":0.000757932662964},"Export JSON":{"start":1761418088.909514904022217,"finish":1761418088.90967607498169,"duration":0.000161170959473},"Write JSON":{"start":1761418088.909519910812378,"finish":1761418088.909672975540161,"duration":0.000153064727783},"Visit JSON":{"start":1761418088.909527063369751,"finish":1761418088.909540891647339,"duration":0.000013828277588},"Render JSON":{"start":1761418088.909543991088867,"finish":1761418088.909601926803589,"duration":0.000057935714722},"Save Uids cache":{"start":1761418088.909604072570801,"finish":1761418088.909626960754394,"duration":0.000022888183594}},"metrics":{"File access":{"loaded size":66,"load time":34,"loaded MD5 time":1,"Max loaded MD5 time":1,"loaded count":2,"max load time":30,"mapped size":0,"mapped MD5 time":0,"Max mapped MD5 time":0,"mapped count":0,"map time":0,"from patch count":0,"from patch size":0,"file stat count":2,"lstat count":2,"lstat sum us":22,"lstat min us":7,"lstat avr us":11,"lstat max us":15,"opendir count":0,"opendir sum us":0,"opendir min us":0,"opendir avr us":0,"opendir max us":0,"readdir count":0,"readdir sum us":0,"readdir min us":0,"readdir avr us":0,"readdir max us":0,"(opendir + readdir) sum us":0,"(lstat + opendir + readdir) sum us":22},"Parsing":{"parse time":0,"parsed files count":0,"parsed files size":0,"parsed files recovered":0,".in files count":0,".in files size":0},"ya.make parsing":{"count":1,"includes count":0,"unique count":1,"size":33,"unique size":33},"DepGraph":{"nodes count":2,"edges count":1,"files count":6,"commands count":16},"UpdIter":{"nuke mod dir":0},"Resolving":{"Includes attempts":0,"From cache":0,"Resolve AsKnown total":0,"Resolve AsKnown from cache":0},"TModules":{"accessed":0,"loaded":0,"outdated":0,"parsed":0,"total":0},"Internal cache":{"Total cache size on save":2912,"Diagnostics cache size on save":1104,"Graph cache size on save":112,"Parsers cache size on save":144,"Modules table size on save":4,"Times table size on save":16,"Names table size on save":816,"Commands cache size on save":272},"JSON cache":{"Loaded cache items":0,"Added cache items":0,"Saved old cache items":0,"Saved new cache items":0,"Saved total cache items":0,"Loaded full match items":0,"Full match requests":0,"Successful full matches":0,"Loaded partial match items":0,"Partial match requests":0,"Successful partial matches":0,"Fully rendered nodes":0,"Partially rendered nodes":0,"Nodes restored without rendering":0},"Uids cache":{"Loaded nodes":0,"Skipped nodes":0,"Discarded nodes":0,"Loaded loops":0,"Skipped loops":0,"Discarded loops":0,"Saved nodes":2,"Saved loops":0,"Really all nodes no rendered":0},"TMakeCommand":{"module environment initialization calls":0,"actual module environment initializations":0}},"binary":"/home/runner/.ya/tools/v4/8069590186/ymake","args":["/home/runner/.ya/tools/v4/8069590186/ymake","--depends-like-recurse","--warn","dirloops,ChkPeers","--write-meta-data","/home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmp6gyy3_ev","--config","/home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a/ymake.conf","--plugins-root","/home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins","--build-root","/home/runner/.ya/build/conf/dist-relwithdebinfo-x-a5b376604af281e0d2ec007fbb2a212a_d357a1f7839b099012272bcb9853ec19","--test-dart","/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/test.dart","--tests-data-root","/home/runner/actions_runner/_work/ydb/arcadia_tests_data","--makefiles-dart","/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.u1fk3323/makefiles.dart","--dump-build-plan","-","--quiet","--events","dGT","/home/runner/actions_runner/_work/ydb/ydb"],"has_changelist":false,"predicts_structural_changes":true,"bypass_is_enabled":false,"bypass_is_triggered":false,"has_content_changes":true,"has_structural_changes":true,"has_rendered_node_changes":true,"exit_code":0,"duration":0.400263547897339} 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=load-graph-from-json, group=graph, time=1761418088.9311705 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage load-graph-from-json_started=1761418088.9311705 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step load-graph-from-json_started - 1761418088.9311705 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Start stage tag=load-graph-from-json, group=graph, time=1761418088.9315646 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage load-graph-from-json_started=1761418088.9315646 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step load-graph-from-json_started - 1761418088.9315646 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=load-graph-from-json, group=graph, time=1761418088.9317763 2025-10-25 18:48:08,931 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage load-graph-from-json_finished=1761418088.9317763 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step load-graph-from-json_finished - 1761418088.9317763 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=gen-graph-json-default-linux-x86_64-relwithdebinfo-nopic, group=graph, time=1761418088.9320993 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-json-default-linux-x86_64-relwithdebinfo-nopic_finished=1761418088.9320993 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-json-default-linux-x86_64-relwithdebinfo-nopic_finished - 1761418088.9320993 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Finish stage tag=load-graph-from-json, group=graph, time=1761418088.9322205 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage load-graph-from-json_finished=1761418088.9322205 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step load-graph-from-json_finished - 1761418088.9322205 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=gen-graph-default-linux-x86_64-relwithdebinfo-nopic, group=graph, time=1761418088.9325466 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-default-linux-x86_64-relwithdebinfo-nopic_finished=1761418088.9325466 2025-10-25 18:48:08,932 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-default-linux-x86_64-relwithdebinfo-nopic_finished - 1761418088.9325466 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Finish stage tag=gen-graph-json-default-linux-x86_64-relwithdebinfo-pic, group=graph, time=1761418088.9327674 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage gen-graph-json-default-linux-x86_64-relwithdebinfo-pic_finished=1761418088.9327674 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step gen-graph-json-default-linux-x86_64-relwithdebinfo-pic_finished - 1761418088.9327674 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_1] Finish stage tag=gen-graph-default-linux-x86_64-relwithdebinfo-pic, group=graph, time=1761418088.933303 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_1] Set stage gen-graph-default-linux-x86_64-relwithdebinfo-pic_finished=1761418088.933303 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_1] Profile step gen-graph-default-linux-x86_64-relwithdebinfo-pic_finished - 1761418088.933303 2025-10-25 18:48:08,933 DEBUG (exts.timer) [MainThread] Timer merge_target_graphs, stage waiting_graphs for default-linux-x86_64-relwithdebinfo: 0.014970541000366211 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=wait-target-graphs-1, group=graph, time=1761418088.9336488 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage wait-target-graphs-1_finished=1761418088.9336488 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step wait-target-graphs-1_finished - 1761418088.9336488 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=union-make-files-1, group=graph, time=1761418088.933809 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage union-make-files-1_started=1761418088.933809 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step union-make-files-1_started - 1761418088.933809 2025-10-25 18:48:08,933 DEBUG (exts.timer) [MainThread] Timer merge_target_graphs, stage union make files for default-linux-x86_64-relwithdebinfo: 0.00039386749267578125 2025-10-25 18:48:08,933 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=union-make-files-1, group=graph, time=1761418088.9339697 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage union-make-files-1_finished=1761418088.9339697 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step union-make-files-1_finished - 1761418088.9339697 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=merge-graphs-1, group=graph, time=1761418088.9340959 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage merge-graphs-1_started=1761418088.9340959 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step merge-graphs-1_started - 1761418088.9340959 2025-10-25 18:48:08,934 DEBUG (exts.timer) [MainThread] Timer merge_target_graphs, stage merge_graphs for default-linux-x86_64-relwithdebinfo: 0.000301361083984375 2025-10-25 18:48:08,934 DEBUG (devtools.ya.build.graph) [MainThread] Graph size is 0 after merge_graphs 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=merge-graphs-1, group=graph, time=1761418088.934467 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage merge-graphs-1_finished=1761418088.934467 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step merge-graphs-1_finished - 1761418088.934467 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=strip-graph-1, group=graph, time=1761418088.934599 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage strip-graph-1_started=1761418088.934599 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step strip-graph-1_started - 1761418088.934599 2025-10-25 18:48:08,934 DEBUG (exts.timer) [MainThread] Timer merge_target_graphs, stage strip_graph for default-linux-x86_64-relwithdebinfo: 0.00047779083251953125 2025-10-25 18:48:08,934 DEBUG (devtools.ya.build.graph) [MainThread] Graph size is 0 after strip_graph 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=strip-graph-1, group=graph, time=1761418088.9347908 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage strip-graph-1_finished=1761418088.9347908 2025-10-25 18:48:08,934 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step strip-graph-1_finished - 1761418088.9347908 2025-10-25 18:48:08,935 DEBUG (devtools.ya.build.graph) [MainThread] Configuring only non-PIC for test_tool_tc1-global 2025-10-25 18:48:08,935 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=gen-graph-test_tool_tc1-nopic-global, group=graph, time=1761418088.935196 2025-10-25 18:48:08,935 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-test_tool_tc1-nopic-global_started=1761418088.935196 2025-10-25 18:48:08,935 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-test_tool_tc1-nopic-global_started - 1761418088.935196 2025-10-25 18:48:08,935 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=gen-graph-gen-opts-test_tool_tc1-nopic-global, group=graph, time=1761418088.9354913 2025-10-25 18:48:08,935 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-gen-opts-test_tool_tc1-nopic-global_started=1761418088.9354913 2025-10-25 18:48:08,935 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-gen-opts-test_tool_tc1-nopic-global_started - 1761418088.9354913 2025-10-25 18:48:08,935 DEBUG (yalibrary.guards) [ThreadPoolExecutor-0_0] Enter guard fetch with value None 2025-10-25 18:48:08,949 DEBUG (devtools.ya.build.genconf) [ThreadPoolExecutor-0_0] Generating conf into /home/runner/.ya/build/conf/dist-relwithdebinfo-349eb7b228d0bd7def6dfe635ca8d2ee/ymake.conf with cmd ['/home/runner/.ya/tools/ce4cd92b15_d/ya-bin', '-B', '/home/runner/actions_runner/_work/ydb/ydb/build/ymake_conf.py', '/home/runner/actions_runner/_work/ydb/ydb', 'dist-relwithdebinfo', 'no', '--toolchain-params', 'eyJib3R0bGVfbmFtZSI6ImNsYW5nMTgiLCJlbnYiOnsiQ1BBVEgiOlsiIl0sIkxJQlJBUllfUEFUSCI6WyIiXSwiU0RLUk9PVCI6WyIiXX0sImV4ZWN1dGFibGVfcGF0aCI6ImMrKyIsImZvcm11bGEiOnsiYnlfcGxhdGZvcm0iOnsiZGFyd2luLWFybTY0Ijp7InVyaSI6InNicjo3NTk5NDg0MjY1In0sImRhcndpbi14ODZfNjQiOnsidXJpIjoic2JyOjc1OTk1MTc1MDYifSwibGludXgtYWFyY2g2NCI6eyJ1cmkiOiJzYnI6NzU5OTI4NTU2NiJ9LCJsaW51eC14ODZfNjQiOnsidXJpIjoic2JyOjc1OTk0NjkxNTYifSwid2luMzIteDg2XzY0Ijp7InVyaSI6InNicjo3NTk5NDIyMTQ0In19fSwibmFtZSI6ImNsYW5nMTgiLCJwYXJhbXMiOnsiY19jb21waWxlciI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2NsYW5nIiwiY3h4X2NvbXBpbGVyIjoiJChDTEFORy0yNTE4MjMxNDMyKS9iaW4vY2xhbmcrKyIsImxsdm0tc3ltYm9saXplciI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2xsdm0tc3ltYm9saXplciIsIm1hdGNoX3Jvb3QiOiJDTEFORy0yNTE4MjMxNDMyIiwibm0iOiIkKENMQU5HLTI1MTgyMzE0MzIpL2Jpbi9sbHZtLW5tIiwib2JqY29weSI6IiQoQ0xBTkctMjUxODIzMTQzMikvYmluL2xsdm0tb2JqY29weSIsInByb2ZpbGVzIjoiJChYQ09ERV9UT09MU19ST09ULXNicjo3OTkwMTc3NzEpL1hjb2RlL0NvbnRlbnRzL0RldmVsb3Blci9QbGF0Zm9ybXMvaVBob25lT1MucGxhdGZvcm0vRGV2ZWxvcGVyL0xpYnJhcnkvQ29yZVNpbXVsYXRvci9Qcm9maWxlcyIsInNpbWN0bCI6IiQoWENPREVfVE9PTFNfUk9PVC1zYnI6Nzk5MDE3NzcxKS9YY29kZS9TeXN0ZW1Sb290L1ByaXZhdGVGcmFtZXdvcmtzL0NvcmVTaW11bGF0b3IuZnJhbWV3b3JrL1Jlc291cmNlcy9iaW4vc2ltY3RsIiwic3RyaXAiOiIkKENMQU5HLTI1MTgyMzE0MzIpL2Jpbi9sbHZtLXN0cmlwIiwidHlwZSI6ImNsYW5nIiwidXNlX2J1bmRsZSI6dHJ1ZSwidmVyc2lvbiI6IjE4In0sInBsYXRmb3JtIjp7Imhvc3QiOnsiYXJjaCI6Ing4Nl82NCIsIm9zIjoiTElOVVgiLCJ0b29sY2hhaW4iOiJkZWZhdWx0IiwidmlzaWJsZV9uYW1lIjoiY2xhbmcxOCJ9LCJ0YXJnZXQiOnsiYXJjaCI6Ing4Nl82NCIsIm9zIjoiTElOVVgiLCJ0b29sY2hhaW4iOiJkZWZhdWx0IiwidmlzaWJsZV9uYW1lIjoiY2xhbmcxOCJ9fSwicGxhdGZvcm1fbmFtZSI6IkRFRkFVTFQtTElOVVgtWDg2XzY0IiwidG9vbF92YXIiOiJDTEFORy0yNTE4MjMxNDMyIn0=', '-l', '-D', 'APPLE_SDK_LOCAL=yes', '-D', 'CFLAGS=-fno-omit-frame-pointer -Wno-unknown-argument', '-D', 'CLANG18=yes', '-D', 'FORCE_NO_PIC=yes', '-D', 'IS_CROSS_SANITIZE=yes', '-D', 'IS_CROSS_TOOLS=yes', '-D', 'OPENSOURCE=yes', '-D', 'TESTS_REQUESTED=yes', '-D', 'TRAVERSE_DEPENDS=yes', '-D', 'TRAVERSE_RECURSE_FOR_TESTS=yes', '-D', 'USE_AIO=static', '-D', 'USE_CLANG_CL=yes', '-D', 'USE_ICONV=static', '-D', 'USE_IDN=static', '-D', 'USE_PREBUILT_TOOLS=no', '-D', 'YA=yes'] and env {'PATH': '/home/runner/actions_runner/_work/ydb/ydb/ydb/ci/scripts:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/snap/bin', 'Y_PYTHON_ENTRY_POINT': ':main'} 2025-10-25 18:48:09,066 DEBUG (devtools.ya.build.genconf) [ThreadPoolExecutor-0_0] Copy conf /home/runner/.ya/build/conf/dist-relwithdebinfo-349eb7b228d0bd7def6dfe635ca8d2ee/ymake.conf to /home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9/ymake.conf 2025-10-25 18:48:09,067 DEBUG (yalibrary.guards) [ThreadPoolExecutor-0_0] Exit guard fetch with value None 2025-10-25 18:48:09,067 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=gen-graph-gen-opts-test_tool_tc1-nopic-global, group=graph, time=1761418089.0673897 2025-10-25 18:48:09,067 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-gen-opts-test_tool_tc1-nopic-global_finished=1761418089.0673897 2025-10-25 18:48:09,067 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-gen-opts-test_tool_tc1-nopic-global_finished - 1761418089.0673897 2025-10-25 18:48:09,067 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=gen-graph-json-test_tool_tc1-nopic-global, group=graph, time=1761418089.0675962 2025-10-25 18:48:09,067 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-json-test_tool_tc1-nopic-global_started=1761418089.0675962 2025-10-25 18:48:09,067 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-json-test_tool_tc1-nopic-global_started - 1761418089.0675962 2025-10-25 18:48:09,067 DEBUG (devtools.ya.build.ymake2) [ThreadPoolExecutor-0_0] Run gen graph with {'grab_stderr': True, 'mode': 'dist', 'dump_graph': 'json', 'check': True, '_purpose': 'test_tool_tc1-nopic-global', 'cpp': True, 'custom_build_directory': '/home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9_d357a1f7839b099012272bcb9853ec19', 'build_type': 'relwithdebinfo', 'abs_targets': ['/home/runner/actions_runner/_work/ydb/ydb/build/platform/test_tool', '/home/runner/actions_runner/_work/ydb/ydb/build/external_resources/go_tools', '/home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py2', '/home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py3', '/home/runner/actions_runner/_work/ydb/ydb/build/platform/java/jstyle_lib'], 'debug_options': [], 'custom_conf': '/home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9/ymake.conf', 'continue_on_fail': False, 'ymake_bin': None, 'warn_mode': ['dirloops', 'ChkPeers'], 'build_depends': 3, 'arcadia_tests_data_path': '/home/runner/actions_runner/_work/ydb/arcadia_tests_data', 'checkout_data_by_ya': False, 'strict_inputs': False, 'dump_inputs_map': False, 'ev_listener': .event_listener_debug_id_wrapper at 0x7f31e293c5e0>, 'enabled_events': 'PSLGE', 'no_caches_on_retry': False, 'no_ymake_retry': False, 'disable_customization': 0, 'dump_tests': '/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/test.dart', 'dump_make_files': '/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/makefiles.dart'} 2025-10-25 18:48:09,067 DEBUG (devtools.ya.core.yarg.behaviour) [ThreadPoolExecutor-0_0] Found unused args ['grab_stderr'] 2025-10-25 18:48:09,068 DEBUG (devtools.ya.build.prefetch) [ThreadPoolExecutor-0_0] prefetch disabled 2025-10-25 18:48:09,068 DEBUG (devtools.ya.core.event_handling.base_subscriber) [ThreadPoolExecutor-0_0] Subscribing PrintProgressSubscriber to event_queue 2025-10-25 18:48:09,068 DEBUG (yalibrary.tools) [ThreadPoolExecutor-0_0] Using old-style toolchain for: ymake 2025-10-25 18:48:09,068 DEBUG (devtools.ya.build.ymake2.run_ymake) [ThreadPoolExecutor-0_0] run: '/home/runner/.ya/tools/v4/8069590186/ymake --depends-like-recurse --warn dirloops,ChkPeers --write-meta-data /home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmp_ds0sg90 --config /home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9/ymake.conf --plugins-root /home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins --build-root /home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9_d357a1f7839b099012272bcb9853ec19 --test-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/test.dart --tests-data-root /home/runner/actions_runner/_work/ydb/arcadia_tests_data --makefiles-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/makefiles.dart --dump-build-plan - --quiet --events PSLGE /home/runner/actions_runner/_work/ydb/ydb/build/platform/test_tool /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/go_tools /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py2 /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py3 /home/runner/actions_runner/_work/ydb/ydb/build/platform/java/jstyle_lib' with env: { } 2025-10-25 18:48:09,457 DEBUG (devtools.ya.build.ymake2.run_ymake) [ThreadPoolExecutor-0_0] run '/home/runner/.ya/tools/v4/8069590186/ymake --depends-like-recurse --warn dirloops,ChkPeers --write-meta-data /home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmp_ds0sg90 --config /home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9/ymake.conf --plugins-root /home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins --build-root /home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9_d357a1f7839b099012272bcb9853ec19 --test-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/test.dart --tests-data-root /home/runner/actions_runner/_work/ydb/arcadia_tests_data --makefiles-dart /home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/makefiles.dart --dump-build-plan - --quiet --events PSLGE /home/runner/actions_runner/_work/ydb/ydb/build/platform/test_tool /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/go_tools /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py2 /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py3 /home/runner/actions_runner/_work/ydb/ydb/build/platform/java/jstyle_lib' finished 2025-10-25 18:48:09,457 DEBUG (devtools.ya.core.event_handling.base_subscriber) [ThreadPoolExecutor-0_0] Unsubscribing PrintProgressSubscriber from event_queue 2025-10-25 18:48:09,458 DEBUG (devtools.ya.build.ymake2) [ThreadPoolExecutor-0_0] ymake_run_info: {"ymake_run_uid":2,"stats":{"preparing":{"start":1761418089.068028211593628,"finish":1761418089.068633079528809,"duration":0.000604867935181},"execution":{"start":1761418089.068633556365967,"finish":1761418089.457671880722046,"duration":0.389038324356079},"postprocessing":{"start":1761418089.45767617225647,"finish":1761418089.458043575286865,"duration":0.000367403030396}},"purpose":"test_tool_tc1-nopic-global","caches":{},"stages":{},"metrics":{},"binary":"/home/runner/.ya/tools/v4/8069590186/ymake","args":["/home/runner/.ya/tools/v4/8069590186/ymake","--depends-like-recurse","--warn","dirloops,ChkPeers","--write-meta-data","/home/runner/.ya/tmp/1761418088.3025.zi64moov/yatmp_ds0sg90","--config","/home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9/ymake.conf","--plugins-root","/home/runner/actions_runner/_work/ydb/ydb/build/plugins,/home/runner/actions_runner/_work/ydb/ydb/build/internal/plugins","--build-root","/home/runner/.ya/build/conf/dist-relwithdebinfo-x-12a1f5ef3ef4dcaab7ce8c21f77300f9_d357a1f7839b099012272bcb9853ec19","--test-dart","/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/test.dart","--tests-data-root","/home/runner/actions_runner/_work/ydb/arcadia_tests_data","--makefiles-dart","/home/runner/.ya/tmp/1761418088.3025.zi64moov/gen_graph.qpbnbm1t/makefiles.dart","--dump-build-plan","-","--quiet","--events","PSLGE","/home/runner/actions_runner/_work/ydb/ydb/build/platform/test_tool","/home/runner/actions_runner/_work/ydb/ydb/build/external_resources/go_tools","/home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py2","/home/runner/actions_runner/_work/ydb/ydb/build/external_resources/flake8_py3","/home/runner/actions_runner/_work/ydb/ydb/build/platform/java/jstyle_lib"],"exit_code":0,"duration":0.389038324356079} 2025-10-25 18:48:09,458 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Start stage tag=load-graph-from-json, group=graph, time=1761418089.4584877 2025-10-25 18:48:09,458 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage load-graph-from-json_started=1761418089.4584877 2025-10-25 18:48:09,458 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step load-graph-from-json_started - 1761418089.4584877 2025-10-25 18:48:09,458 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=load-graph-from-json, group=graph, time=1761418089.4588552 2025-10-25 18:48:09,458 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage load-graph-from-json_finished=1761418089.4588552 2025-10-25 18:48:09,458 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step load-graph-from-json_finished - 1761418089.4588552 2025-10-25 18:48:09,459 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=gen-graph-json-test_tool_tc1-nopic-global, group=graph, time=1761418089.4590402 2025-10-25 18:48:09,459 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-json-test_tool_tc1-nopic-global_finished=1761418089.4590402 2025-10-25 18:48:09,459 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-json-test_tool_tc1-nopic-global_finished - 1761418089.4590402 2025-10-25 18:48:09,459 DEBUG (devtools.ya.core.stage_tracer) [ThreadPoolExecutor-0_0] Finish stage tag=gen-graph-test_tool_tc1-nopic-global, group=graph, time=1761418089.459354 2025-10-25 18:48:09,459 DEBUG (devtools.ya.core.stages_profiler) [ThreadPoolExecutor-0_0] Set stage gen-graph-test_tool_tc1-nopic-global_finished=1761418089.459354 2025-10-25 18:48:09,459 DEBUG (devtools.ya.core.profiler) [ThreadPoolExecutor-0_0] Profile step gen-graph-test_tool_tc1-nopic-global_finished - 1761418089.459354 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=get-graph-1, group=graph, time=1761418089.4599931 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage get-graph-1_started=1761418089.4599931 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step get-graph-1_started - 1761418089.4599931 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=get-graph-1, group=graph, time=1761418089.4602664 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage get-graph-1_finished=1761418089.4602664 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step get-graph-1_finished - 1761418089.4602664 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=merge-target-graphs-1, group=graph, time=1761418089.4604394 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage merge-target-graphs-1_finished=1761418089.4604394 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step merge-target-graphs-1_finished - 1761418089.4604394 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=build-merged-graph, group=graph, time=1761418089.460588 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build-merged-graph_started=1761418089.460588 2025-10-25 18:48:09,460 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build-merged-graph_started - 1761418089.460588 2025-10-25 18:48:09,461 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=insert-tests-1, group=graph, time=1761418089.461267 2025-10-25 18:48:09,461 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage insert-tests-1_started=1761418089.461267 2025-10-25 18:48:09,461 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step insert-tests-1_started - 1761418089.461267 2025-10-25 18:48:09,461 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'unsupported cross-compiled tests' on 0 suites 2025-10-25 18:48:09,461 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter '. at 0x7f31e36bb880>' on 0 suites 2025-10-25 18:48:09,461 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'size' on 0 suites 2025-10-25 18:48:09,461 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'class type' on 0 suites 2025-10-25 18:48:09,461 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'suite type' on 0 suites 2025-10-25 18:48:09,461 DEBUG (devtools.ya.test.filter) [MainThread] Tags filter include set:[] exclude set:[] 2025-10-25 18:48:09,461 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'tags' on 0 suites 2025-10-25 18:48:09,462 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'project path' on 0 suites 2025-10-25 18:48:09,462 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'filename filter' on 0 suites 2025-10-25 18:48:09,462 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'chunk filter' on 0 suites 2025-10-25 18:48:09,462 DEBUG (devtools.ya.test.filter) [MainThread] Going to apply filter 'name' on 0 suites 2025-10-25 18:48:09,462 DEBUG (devtools.ya.build.graph) [MainThread] Generating build plan 2025-10-25 18:48:09,462 DEBUG (devtools.ya.build.graph) [MainThread] Preparing test suites 2025-10-25 18:48:09,462 DEBUG (devtools.ya.build.graph) [MainThread] Stripping clang-tidy irrelevant deps 2025-10-25 18:48:09,462 DEBUG (exts.timer) [MainThread] Timer inject_tests, stage inject tests for default-linux-x86_64-relwithdebinfo: 0.0009551048278808594 2025-10-25 18:48:09,462 DEBUG (devtools.ya.build.graph) [MainThread] injected 0 tests for default-linux-x86_64-relwithdebinfo 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=insert-tests-1, group=graph, time=1761418089.4624593 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage insert-tests-1_finished=1761418089.4624593 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step insert-tests-1_finished - 1761418089.4624593 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=merge-target-graphs-1, group=graph, time=1761418089.462597 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage merge-target-graphs-1_started=1761418089.462597 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step merge-target-graphs-1_started - 1761418089.462597 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=merge-target-graphs-1, group=graph, time=1761418089.4627225 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage merge-target-graphs-1_finished=1761418089.4627225 2025-10-25 18:48:09,462 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step merge-target-graphs-1_finished - 1761418089.4627225 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.config) [MainThread] Read config "build/platform/python/ymake_python2/resources.json" from resource 2025-10-25 18:48:09,463 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] python: will use 'linux-x86_64' platform 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.config) [MainThread] Reading contents of /home/runner/actions_runner/_work/ydb/ydb/build/external_resources/gdb/resources.json 2025-10-25 18:48:09,463 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] gdb: will use 'linux-x86_64' platform 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=build-merged-graph, group=graph, time=1761418089.4636097 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build-merged-graph_finished=1761418089.4636097 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build-merged-graph_finished - 1761418089.4636097 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=iter-extra-resources, group=graph, time=1761418089.4637501 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage iter-extra-resources_started=1761418089.4637501 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step iter-extra-resources_started - 1761418089.4637501 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=iter-extra-resources, group=graph, time=1761418089.4638605 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage iter-extra-resources_finished=1761418089.4638605 2025-10-25 18:48:09,463 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step iter-extra-resources_finished - 1761418089.4638605 2025-10-25 18:48:09,463 DEBUG (exts.timer) [MainThread] Timer devtools.ya.build.graph, stage build and merge graphs: 1.0971646308898926 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=strip-graph, group=graph, time=1761418089.4640226 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage strip-graph_started=1761418089.4640226 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step strip-graph_started - 1761418089.4640226 2025-10-25 18:48:09,464 DEBUG (devtools.ya.build.graph) [MainThread] stripped 0, left 0 nodes 2025-10-25 18:48:09,464 DEBUG (exts.timer) [MainThread] Timer devtools.ya.build.graph, stage strip graph: 0.0002028942108154297 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=strip-graph, group=graph, time=1761418089.4642174 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage strip-graph_finished=1761418089.4642174 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step strip-graph_finished - 1761418089.4642174 2025-10-25 18:48:09,464 DEBUG (exts.timer) [MainThread] Timer devtools.ya.build.graph, stage gen rename nodes: 0.0001709461212158203 2025-10-25 18:48:09,464 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] python: will use 'linux-x86_64' platform 2025-10-25 18:48:09,464 DEBUG (yalibrary.fetcher.tool_chain_fetcher) [MainThread] ymake: will use 'linux' platform 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=inject_default_requirements, group=graph, time=1761418089.4646318 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage inject_default_requirements_started=1761418089.4646318 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step inject_default_requirements_started - 1761418089.4646318 2025-10-25 18:48:09,464 DEBUG (devtools.ya.build.graph) [MainThread] Updated requirements for 0 nodes 2025-10-25 18:48:09,464 DEBUG (exts.timer) [MainThread] Timer substitude_uids, stage substitude_uids: 1.9073486328125e-06 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=inject_default_requirements, group=graph, time=1761418089.4648426 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage inject_default_requirements_finished=1761418089.4648426 2025-10-25 18:48:09,464 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step inject_default_requirements_finished - 1761418089.4648426 2025-10-25 18:48:09,464 DEBUG (exts.timer) [MainThread] Timer devtools.ya.build.graph, stage misc graph changes: 0.0006129741668701172 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=finalize-graph, group=graph, time=1761418089.4650044 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage finalize-graph_started=1761418089.4650044 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step finalize-graph_started - 1761418089.4650044 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=finalize-graph, group=graph, time=1761418089.4651148 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage finalize-graph_finished=1761418089.4651148 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step finalize-graph_finished - 1761418089.4651148 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=imprint-store-and-stats, group=graph, time=1761418089.4652307 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage imprint-store-and-stats_started=1761418089.4652307 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step imprint-store-and-stats_started - 1761418089.4652307 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.imprint.imprint:Imprint) [MainThread] 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.imprint.imprint:Imprint) [MainThread] 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.imprint.imprint:Imprint) [MainThread] 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=imprint-store-and-stats, group=graph, time=1761418089.4654777 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage imprint-store-and-stats_finished=1761418089.4654777 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step imprint-store-and-stats_finished - 1761418089.4654777 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=inject_stats_and_static_uids, group=graph, time=1761418089.4655945 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage inject_stats_and_static_uids_started=1761418089.4655945 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step inject_stats_and_static_uids_started - 1761418089.4655945 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=inject_stats_and_static_uids, group=graph, time=1761418089.4657023 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage inject_stats_and_static_uids_finished=1761418089.4657023 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step inject_stats_and_static_uids_finished - 1761418089.4657023 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=strip-tags, group=graph, time=1761418089.4658196 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage strip-tags_started=1761418089.4658196 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step strip-tags_started - 1761418089.4658196 2025-10-25 18:48:09,465 DEBUG (exts.timer) [MainThread] Timer devtools.ya.build.graph, stage strip tags: 0.0009791851043701172 2025-10-25 18:48:09,465 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=strip-tags, group=graph, time=1761418089.4659798 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage strip-tags_finished=1761418089.4659798 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step strip-tags_finished - 1761418089.4659798 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=reduce_graph_resources, group=graph, time=1761418089.4661777 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage reduce_graph_resources_started=1761418089.4661777 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step reduce_graph_resources_started - 1761418089.4661777 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=reduce_graph_resources, group=graph, time=1761418089.4663281 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage reduce_graph_resources_finished=1761418089.4663281 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step reduce_graph_resources_finished - 1761418089.4663281 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=clean-intern-string-storage, group=graph, time=1761418089.4664564 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage clean-intern-string-storage_started=1761418089.4664564 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step clean-intern-string-storage_started - 1761418089.4664564 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=clean-intern-string-storage, group=graph, time=1761418089.4666152 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage clean-intern-string-storage_finished=1761418089.4666152 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step clean-intern-string-storage_finished - 1761418089.4666152 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=build_graph_and_tests, group=graph, time=1761418089.4667325 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build_graph_and_tests_finished=1761418089.4667325 2025-10-25 18:48:09,466 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build_graph_and_tests_finished - 1761418089.4667325 2025-10-25 18:48:09,467 DEBUG (exts.timer) [MainThread] Timer context_creation, stage graph_and_tests finished: 1.1327941417694092 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=configure-dist-store-cache, group=ya_make, time=1761418089.4690032 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage configure-dist-store-cache_started=1761418089.4690032 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step configure-dist-store-cache_started - 1761418089.4690032 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=configure-dist-store-cache, group=ya_make, time=1761418089.4691625 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage configure-dist-store-cache_finished=1761418089.4691625 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step configure-dist-store-cache_finished - 1761418089.4691625 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=configure-local-cache, group=ya_make, time=1761418089.4692986 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage configure-local-cache_started=1761418089.4692986 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step configure-local-cache_started - 1761418089.4692986 2025-10-25 18:48:09,469 DEBUG (devtools.ya.build.ya_make) [MainThread] content UIDs forced 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=configure-local-cache, group=ya_make, time=1761418089.4695394 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage configure-local-cache_finished=1761418089.4695394 2025-10-25 18:48:09,469 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step configure-local-cache_finished - 1761418089.4695394 2025-10-25 18:48:09,469 DEBUG (devtools.ya.build.ya_make) [MainThread] sandbox_run_test_uids: set() 2025-10-25 18:48:09,469 DEBUG (devtools.ya.build.ya_make) [MainThread] Strip graph due bazel_remote_store mode 2025-10-25 18:48:09,469 DEBUG (devtools.ya.build.graph) [MainThread] stripped 0, left 0 nodes 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=context_creation, group=ya_make, time=1761418089.474159 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage context_creation_finished=1761418089.474159 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step context_creation_finished - 1761418089.474159 2025-10-25 18:48:09,474 DEBUG (exts.timer) [MainThread] Timer context_creation, stage context_creation finished: 0.007349729537963867 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=context_generating, group=build_handler, time=1761418089.4746332 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage context_generating_finished=1761418089.4746332 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step context_generating_finished - 1761418089.4746332 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=build, group=build_handler, time=1761418089.4748073 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build_started=1761418089.4748073 2025-10-25 18:48:09,474 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build_started - 1761418089.4748073 2025-10-25 18:48:09,475 DEBUG (devtools.ya.build.reports.autocheck_report) [MainThread] Got 0 tests to report 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish style report 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish style report 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish tests report, tests by size defaultdict(, {'small': set(), 'medium': set(), 'large': set()}), tests by type defaultdict(, {}) 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish tests report 2025-10-25 18:48:09,475 DEBUG (ReportGenerator) [MainThread] Finish configure report 2025-10-25 18:48:09,475 DEBUG (StoredReport) [MainThread] Finish configure report 2025-10-25 18:48:09,475 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=cache_test_statuses, group=ya_make, time=1761418089.4759505 2025-10-25 18:48:09,476 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage cache_test_statuses_started=1761418089.4759505 2025-10-25 18:48:09,476 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step cache_test_statuses_started - 1761418089.4759505 2025-10-25 18:48:09,491 DEBUG (yalibrary.store.new_store) [MainThread] Initialized store in /home/runner/.ya/build/cache/trc 2025-10-25 18:48:09,491 DEBUG (yalibrary.store.new_store) [MainThread] Started filtering 2025-10-25 18:48:09,491 DEBUG (library.python.filelock) [MainThread] Acquiring FileLock (blocking=True): /home/runner/.ya/build/cache/trc/lru/queue/consume.lock 2025-10-25 18:48:09,491 DEBUG (library.python.filelock) [MainThread] Ensuring FileLock released: /home/runner/.ya/build/cache/trc/lru/queue/consume.lock 2025-10-25 18:48:09,491 DEBUG (yalibrary.store.new_store) [MainThread] Done filtering, retain 0 uids, 0 files 2025-10-25 18:48:09,491 DEBUG (yalibrary.store.new_store) [MainThread] Cleaning size store 2025-10-25 18:48:09,491 DEBUG (yalibrary.store.new_store) [MainThread] Cleaning file store 2025-10-25 18:48:09,493 DEBUG (yalibrary.store.new_store) [MainThread] Cleaning uid store 2025-10-25 18:48:09,499 DEBUG (library.python.filelock) [MainThread] Acquiring FileLock (blocking=True): /home/runner/.ya/build/cache/trc/lru/queue/consume.lock 2025-10-25 18:48:09,500 DEBUG (library.python.filelock) [MainThread] Ensuring FileLock released: /home/runner/.ya/build/cache/trc/lru/queue/consume.lock 2025-10-25 18:48:09,500 DEBUG (library.python.filelock) [MainThread] Acquiring FileLock (blocking=True): /home/runner/.ya/build/cache/trc/lru/queue/consume.lock 2025-10-25 18:48:09,501 DEBUG (library.python.filelock) [MainThread] Ensuring FileLock released: /home/runner/.ya/build/cache/trc/lru/queue/consume.lock 2025-10-25 18:48:09,501 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=cache_test_statuses, group=ya_make, time=1761418089.5010948 2025-10-25 18:48:09,501 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage cache_test_statuses_finished=1761418089.5010948 2025-10-25 18:48:09,501 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step cache_test_statuses_finished - 1761418089.5010948 2025-10-25 18:48:09,501 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=finalize-reports, group=ya_make, time=1761418089.5013964 2025-10-25 18:48:09,501 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage finalize-reports_started=1761418089.5013964 2025-10-25 18:48:09,501 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step finalize-reports_started - 1761418089.5013964 2025-10-25 18:48:09,501 DEBUG (devtools.ya.build.ya_make) [MainThread] Build is finished, process results 2025-10-25 18:48:09,501 DEBUG (ReportGenerator) [MainThread] Build result is processed, add 0 entries 2025-10-25 18:48:09,501 DEBUG (ReportGenerator) [MainThread] Finish build report 2025-10-25 18:48:09,501 DEBUG (StoredReport) [MainThread] Finish build report 2025-10-25 18:48:09,501 DEBUG (ReportGenerator) [MainThread] Finish tests report, tests by size defaultdict(, {'small': set(), 'medium': set(), 'large': set()}), tests by type defaultdict(, {}) 2025-10-25 18:48:09,501 DEBUG (ReportGenerator) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,501 DEBUG (StoredReport) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,501 DEBUG (ReportGenerator) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,501 DEBUG (StoredReport) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,501 DEBUG (ReportGenerator) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,501 DEBUG (StoredReport) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,501 DEBUG (StoredReport) [MainThread] Finish tests report 2025-10-25 18:48:09,501 DEBUG (ReportGenerator) [MainThread] Finish style report 2025-10-25 18:48:09,502 DEBUG (StoredReport) [MainThread] Finish style report 2025-10-25 18:48:09,502 DEBUG (ReportGenerator) [MainThread] Finish report 2025-10-25 18:48:09,502 DEBUG (StoredReport) [MainThread] Finish report 2025-10-25 18:48:09,502 DEBUG (devtools.ya.build.ya_make) [MainThread] Build results listener statistics: {} 2025-10-25 18:48:09,502 DEBUG (devtools.ya.build.ya_make) [MainThread] Generating results report 2025-10-25 18:48:09,502 INFO (devtools.ya.build.reports.build_reports) [MainThread] Dump junit report to /home/runner/actions_runner/_work/ydb/ydb/tmp/results/try_1/junit.xml 2025-10-25 18:48:09,502 DEBUG (devtools.ya.build.reports.autocheck_report) [MainThread] Got 0 tests to report 2025-10-25 18:48:09,502 DEBUG (ReportGenerator) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,502 DEBUG (StoredReport) [MainThread] Finish tests report by size small 2025-10-25 18:48:09,502 DEBUG (ReportGenerator) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,502 DEBUG (StoredReport) [MainThread] Finish tests report by size medium 2025-10-25 18:48:09,502 DEBUG (ReportGenerator) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,502 DEBUG (StoredReport) [MainThread] Finish tests report by size large 2025-10-25 18:48:09,502 DEBUG (ReportGenerator) [MainThread] Build result is processed, add 0 entries 2025-10-25 18:48:09,503 DEBUG (devtools.ya.build.reports.autocheck_report) [MainThread] builder.opts.report_skipped_suites: False, builder.opts.report_skipped_suites False 2025-10-25 18:48:09,503 INFO (devtools.ya.build.reports.build_reports) [MainThread] Dump results report to /home/runner/actions_runner/_work/ydb/ydb/tmp/results/try_1/report.json 2025-10-25 18:48:09,503 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=finalize-reports, group=ya_make, time=1761418089.5032535 2025-10-25 18:48:09,503 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage finalize-reports_finished=1761418089.5032535 2025-10-25 18:48:09,503 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step finalize-reports_finished - 1761418089.5032535 2025-10-25 18:48:09,505 DEBUG (yalibrary.toolscache) [MainThread] AC cache attempt: (release all data) 2025-10-25 18:48:09,506 DEBUG (yalibrary.toolscache) [MainThread] AC cache (release all data) address: (2610, 52322, 'unix:/home/runner/.ya/build/cache/7/psingppDP7v.tmp') 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=build, group=build_handler, time=1761418089.5072272 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage build_finished=1761418089.5072272 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step build_finished - 1761418089.5072272 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Start stage tag=dump_results, group=build_handler, time=1761418089.5074499 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage dump_results_started=1761418089.5074499 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step dump_results_started - 1761418089.5074499 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=dump_results, group=build_handler, time=1761418089.507932 2025-10-25 18:48:09,507 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage dump_results_finished=1761418089.507932 2025-10-25 18:48:09,508 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step dump_results_finished - 1761418089.507932 2025-10-25 18:48:09,508 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=ya_make_handler, group=build_handler, time=1761418089.5080955 2025-10-25 18:48:09,508 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage ya_make_handler_finished=1761418089.5080955 2025-10-25 18:48:09,508 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step ya_make_handler_finished - 1761418089.5080955 2025-10-25 18:48:09,508 DEBUG (devtools.ya.core.stage_tracer) [MainThread] Finish stage tag=invoke-do_ya_make, group=overall-execution, time=1761418089.5083246 2025-10-25 18:48:09,508 DEBUG (devtools.ya.core.stages_profiler) [MainThread] Set stage invoke-do_ya_make_finished=1761418089.5083246 2025-10-25 18:48:09,508 DEBUG (devtools.ya.core.profiler) [MainThread] Profile step invoke-do_ya_make_finished - 1761418089.5083246 2025-10-25 18:48:09,508 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "dump_debug" stopped in 0.000465 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "evlog" stopped in 0.000024 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "changelist_store" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "event_queue" stopped in 0.000004 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "mlockall" stopped in 0.000004 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "profile" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "showstack" stopped in 0.000020 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetcher" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetchers_storage" stopped in 0.000004 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "hide_token2" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "docker_config_path" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "use_universal_fetcher_everywhere" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetcher_params" stopped in 0.000005 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "self_info" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "vcs_type" stopped in 0.000002 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "display_log" stopped in 0.000005 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "custom_file_log" stopped in 0.000008 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "display" stopped in 0.000020 2025-10-25 18:48:09,509 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "state" stopped in 0.000007 2025-10-25 18:48:09,510 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "hide_token" stopped in 0.000001 2025-10-25 18:48:09,510 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "params" stopped in 0.000001 2025-10-25 18:48:09,510 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Restored ctx dict_keys(['uid', 'username', 'file_log', 'display_in_memory_log', 'file_in_memory_log', 'revision', 'vcs_type', 'exit', 'metrics_reporter', 'report', 'exit_code', 'lifecycle_ts', 'env_checker', 'fetchers_storage', 'tmp_dir']) 2025-10-25 18:48:09,510 DEBUG (library.python.tmp) [MainThread] Removing tmp dir /home/runner/.ya/tmp/1761418088.3025.zi64moov 2025-10-25 18:48:09,511 DEBUG (library.python.tmp) [MainThread] Reset back TMPDIR=None 2025-10-25 18:48:09,511 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "tmp_dir" stopped in 0.000659 2025-10-25 18:48:09,511 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "fetchers_storage" stopped in 0.000010 2025-10-25 18:48:09,511 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "env_checker" stopped in 0.000006 2025-10-25 18:48:09,511 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "lifecycle_ts" stopped in 0.000003 2025-10-25 18:48:09,511 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "exit_code" stopped in 0.000006 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "report" stopped in 0.001065 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "metrics_reporter" stopped in 0.000008 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "exit" stopped in 0.000006 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "vcs_type" stopped in 0.000005 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "revision" stopped in 0.000004 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "file_in_memory_log" stopped in 0.000007 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "display_in_memory_log" stopped in 0.000005 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "file_log" stopped in 0.000011 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "username" stopped in 0.000004 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Module "uid" stopped in 0.000003 2025-10-25 18:48:09,512 DEBUG (devtools.ya.yalibrary.app_ctx) [MainThread] Restored ctx dict_keys([])