[22:41:15.463] New invocation is queued and will start shortly
[22:41:16.538] Starting the invocation (attempt 1)
[22:41:16.568] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:41:16.568] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:41:16.568] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9019262025606417696",
"parameters_json": "{\"builder_name\":\"win-asan\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"133d88fb6be10eb7fa944b8cf5986ee93de6a6b6\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:win-asan",
"scheduler_invocation_id:9019262025606417696",
"scheduler_job_id:chromium/win-asan",
"user_agent:luci-scheduler",
"buildset:commit/git/133d88fb6be10eb7fa944b8cf5986ee93de6a6b6",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/133d88fb6be10eb7fa944b8cf5986ee93de6a6b6",
"gitiles_ref:refs/heads/master"
]
}
[22:41:17.318] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1614724876668832",
"id": "8853831963680918032",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"133d88fb6be10eb7fa944b8cf5986ee93de6a6b6\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1614724877169119",
"tags": [
"build_address:luci.chromium.ci/win-asan/17599",
"builder:win-asan",
"buildset:commit/git/133d88fb6be10eb7fa944b8cf5986ee93de6a6b6",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/133d88fb6be10eb7fa944b8cf5986ee93de6a6b6",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019262025606417696",
"scheduler_job_id:chromium/win-asan",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8853831963680918032/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1614724877169273",
"url": "https://ci.chromium.org/b/8853831963680918032",
"utcnow_ts": "1614724877307943"
}
}
[22:41:17.318] Task URL: https://ci.chromium.org/b/8853831963680918032
[22:41:17.318] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:2:0) after 1m0s
[22:41:21.681] Received PubSub notification, asking Buildbucket for the build status
[22:41:21.773] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:42:17.486] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:2:0)
[22:42:17.486] Timer tick, asking Buildbucket for the build status
[22:42:17.560] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:42:17.560] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:4:0) after 1m0s
[22:43:17.590] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:4:0)
[22:43:17.590] Timer tick, asking Buildbucket for the build status
[22:43:17.692] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:43:17.692] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:5:0) after 1m0s
[22:44:17.833] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:5:0)
[22:44:17.833] Timer tick, asking Buildbucket for the build status
[22:44:18.456] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:44:18.456] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:6:0) after 1m0s
[22:45:19.030] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:6:0)
[22:45:19.030] Timer tick, asking Buildbucket for the build status
[22:45:19.141] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:45:19.141] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:7:0) after 1m0s
[22:46:19.307] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:7:0)
[22:46:19.307] Timer tick, asking Buildbucket for the build status
[22:46:19.402] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:46:19.402] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:8:0) after 1m0s
[22:47:19.610] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:8:0)
[22:47:19.610] Timer tick, asking Buildbucket for the build status
[22:47:19.679] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:47:19.679] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:9:0) after 1m0s
[22:48:19.672] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:9:0)
[22:48:19.672] Timer tick, asking Buildbucket for the build status
[22:48:22.232] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:48:22.232] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:10:0) after 1m0s
[22:49:22.466] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:10:0)
[22:49:22.466] Timer tick, asking Buildbucket for the build status
[22:49:22.554] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:49:22.554] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:11:0) after 1m0s
[22:50:22.654] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:11:0)
[22:50:22.654] Timer tick, asking Buildbucket for the build status
[22:50:22.748] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:50:22.748] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:12:0) after 1m0s
[22:51:22.765] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:12:0)
[22:51:22.765] Timer tick, asking Buildbucket for the build status
[22:51:23.135] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:51:23.135] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:13:0) after 1m0s
[22:52:23.313] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:13:0)
[22:52:23.313] Timer tick, asking Buildbucket for the build status
[22:52:23.387] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:52:23.387] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:14:0) after 1m0s
[22:53:23.397] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:14:0)
[22:53:23.397] Timer tick, asking Buildbucket for the build status
[22:53:23.532] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:23.532] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:15:0) after 1m0s
[22:54:23.590] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:15:0)
[22:54:23.590] Timer tick, asking Buildbucket for the build status
[22:54:23.761] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:23.761] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:16:0) after 1m0s
[22:55:23.778] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:16:0)
[22:55:23.778] Timer tick, asking Buildbucket for the build status
[22:55:23.861] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:23.861] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:17:0) after 1m0s
[22:56:23.973] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:17:0)
[22:56:23.973] Timer tick, asking Buildbucket for the build status
[22:56:24.051] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:24.051] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:18:0) after 1m0s
[22:57:24.151] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:18:0)
[22:57:24.151] Timer tick, asking Buildbucket for the build status
[22:57:24.223] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:24.223] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:19:0) after 1m0s
[22:58:24.256] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:19:0)
[22:58:24.256] Timer tick, asking Buildbucket for the build status
[22:58:24.340] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:24.340] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:20:0) after 1m0s
[22:59:24.408] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:20:0)
[22:59:24.408] Timer tick, asking Buildbucket for the build status
[22:59:24.496] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:24.496] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:21:0) after 1m0s
[23:00:24.579] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:21:0)
[23:00:24.579] Timer tick, asking Buildbucket for the build status
[23:00:24.675] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:24.676] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:22:0) after 1m0s
[23:01:24.661] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:22:0)
[23:01:24.661] Timer tick, asking Buildbucket for the build status
[23:01:24.760] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:24.760] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:23:0) after 1m0s
[23:02:25.084] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:23:0)
[23:02:25.084] Timer tick, asking Buildbucket for the build status
[23:02:27.783] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:27.783] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:24:0) after 1m0s
[23:03:27.825] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:24:0)
[23:03:27.825] Timer tick, asking Buildbucket for the build status
[23:03:27.898] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:27.898] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:25:0) after 1m0s
[23:04:27.935] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:25:0)
[23:04:27.935] Timer tick, asking Buildbucket for the build status
[23:04:28.070] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:28.070] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:26:0) after 1m0s
[23:05:28.070] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:26:0)
[23:05:28.070] Timer tick, asking Buildbucket for the build status
[23:05:28.147] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:28.147] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:27:0) after 1m0s
[23:06:28.165] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:27:0)
[23:06:28.165] Timer tick, asking Buildbucket for the build status
[23:06:28.260] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:28.260] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:28:0) after 1m0s
[23:07:28.252] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:28:0)
[23:07:28.252] Timer tick, asking Buildbucket for the build status
[23:07:29.754] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:29.754] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:29:0) after 1m0s
[23:08:29.771] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:29:0)
[23:08:29.771] Timer tick, asking Buildbucket for the build status
[23:08:29.856] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:29.856] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:30:0) after 1m0s
[23:09:29.935] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:30:0)
[23:09:29.935] Timer tick, asking Buildbucket for the build status
[23:09:30.011] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:30.011] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:31:0) after 1m0s
[23:10:30.062] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:31:0)
[23:10:30.062] Timer tick, asking Buildbucket for the build status
[23:10:30.160] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:30.160] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:32:0) after 1m0s
[23:11:30.189] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:32:0)
[23:11:30.189] Timer tick, asking Buildbucket for the build status
[23:11:30.283] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:30.283] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:33:0) after 1m0s
[23:12:30.307] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:33:0)
[23:12:30.307] Timer tick, asking Buildbucket for the build status
[23:12:30.441] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:30.441] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:34:0) after 1m0s
[23:13:30.504] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:34:0)
[23:13:30.504] Timer tick, asking Buildbucket for the build status
[23:13:30.584] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:30.584] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:35:0) after 1m0s
[23:14:30.599] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:35:0)
[23:14:30.599] Timer tick, asking Buildbucket for the build status
[23:14:30.657] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:30.657] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:36:0) after 1m0s
[23:15:30.742] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:36:0)
[23:15:30.742] Timer tick, asking Buildbucket for the build status
[23:15:30.803] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:30.803] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:37:0) after 1m0s
[23:16:30.898] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:37:0)
[23:16:30.898] Timer tick, asking Buildbucket for the build status
[23:16:30.987] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:30.987] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:38:0) after 1m0s
[23:17:31.116] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:38:0)
[23:17:31.116] Timer tick, asking Buildbucket for the build status
[23:17:31.183] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:31.183] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:39:0) after 1m0s
[23:18:31.239] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:39:0)
[23:18:31.239] Timer tick, asking Buildbucket for the build status
[23:18:31.339] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:31.339] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:40:0) after 1m0s
[23:19:31.438] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:40:0)
[23:19:31.438] Timer tick, asking Buildbucket for the build status
[23:19:31.542] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:31.542] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:41:0) after 1m0s
[23:20:31.560] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:41:0)
[23:20:31.560] Timer tick, asking Buildbucket for the build status
[23:20:31.744] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:31.744] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:42:0) after 1m0s
[23:21:31.722] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:42:0)
[23:21:31.722] Timer tick, asking Buildbucket for the build status
[23:21:31.807] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:31.808] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:43:0) after 1m0s
[23:22:31.827] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:43:0)
[23:22:31.827] Timer tick, asking Buildbucket for the build status
[23:22:31.928] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:31.928] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:44:0) after 1m0s
[23:23:31.999] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:44:0)
[23:23:31.999] Timer tick, asking Buildbucket for the build status
[23:23:32.342] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:32.342] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:45:0) after 1m0s
[23:24:32.380] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:45:0)
[23:24:32.380] Timer tick, asking Buildbucket for the build status
[23:24:32.539] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:32.539] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:46:0) after 1m0s
[23:25:32.556] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:46:0)
[23:25:32.556] Timer tick, asking Buildbucket for the build status
[23:25:32.632] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:32.632] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:47:0) after 1m0s
[23:26:32.878] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:47:0)
[23:26:32.878] Timer tick, asking Buildbucket for the build status
[23:26:33.018] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:33.018] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:48:0) after 1m0s
[23:27:33.116] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:48:0)
[23:27:33.116] Timer tick, asking Buildbucket for the build status
[23:27:33.182] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:33.182] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:49:0) after 1m0s
[23:28:33.199] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:49:0)
[23:28:33.199] Timer tick, asking Buildbucket for the build status
[23:28:33.292] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:33.292] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:50:0) after 1m0s
[23:29:33.666] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:50:0)
[23:29:33.666] Timer tick, asking Buildbucket for the build status
[23:29:34.664] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:34.664] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:51:0) after 1m0s
[23:30:36.560] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:51:0)
[23:30:36.560] Timer tick, asking Buildbucket for the build status
[23:30:36.776] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:36.776] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:52:0) after 1m0s
[23:31:36.850] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:52:0)
[23:31:36.850] Timer tick, asking Buildbucket for the build status
[23:31:36.933] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:36.933] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:53:0) after 1m0s
[23:32:36.983] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:53:0)
[23:32:36.983] Timer tick, asking Buildbucket for the build status
[23:32:37.048] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:37.048] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:54:0) after 1m0s
[23:33:37.045] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:54:0)
[23:33:37.045] Timer tick, asking Buildbucket for the build status
[23:33:37.134] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:37.134] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:55:0) after 1m0s
[23:34:37.158] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:55:0)
[23:34:37.158] Timer tick, asking Buildbucket for the build status
[23:34:37.237] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:37.237] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:56:0) after 1m0s
[23:35:37.254] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:56:0)
[23:35:37.254] Timer tick, asking Buildbucket for the build status
[23:35:37.327] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:37.327] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:57:0) after 1m0s
[23:36:37.363] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:57:0)
[23:36:37.363] Timer tick, asking Buildbucket for the build status
[23:36:37.433] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:37.433] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:58:0) after 1m0s
[23:37:37.473] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:58:0)
[23:37:37.473] Timer tick, asking Buildbucket for the build status
[23:37:37.564] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:37.564] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:59:0) after 1m0s
[23:38:37.772] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:59:0)
[23:38:37.772] Timer tick, asking Buildbucket for the build status
[23:38:38.127] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:38.127] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:60:0) after 1m0s
[23:39:38.167] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:60:0)
[23:39:38.167] Timer tick, asking Buildbucket for the build status
[23:39:38.509] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:38.509] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:61:0) after 1m0s
[23:40:38.550] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:61:0)
[23:40:38.550] Timer tick, asking Buildbucket for the build status
[23:40:38.613] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:38.613] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:62:0) after 1m0s
[23:41:38.624] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:62:0)
[23:41:38.624] Timer tick, asking Buildbucket for the build status
[23:41:39.168] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:39.168] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:63:0) after 1m0s
[23:42:39.260] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:63:0)
[23:42:39.260] Timer tick, asking Buildbucket for the build status
[23:42:39.333] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:39.333] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:64:0) after 1m0s
[23:43:39.362] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:64:0)
[23:43:39.362] Timer tick, asking Buildbucket for the build status
[23:43:39.424] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:39.424] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:65:0) after 1m0s
[23:44:39.409] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:65:0)
[23:44:39.409] Timer tick, asking Buildbucket for the build status
[23:44:39.482] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:39.482] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:66:0) after 1m0s
[23:45:39.482] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:66:0)
[23:45:39.482] Timer tick, asking Buildbucket for the build status
[23:45:39.557] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:39.557] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:67:0) after 1m0s
[23:46:39.632] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:67:0)
[23:46:39.632] Timer tick, asking Buildbucket for the build status
[23:46:39.744] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:39.744] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:68:0) after 1m0s
[23:47:39.969] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:68:0)
[23:47:39.969] Timer tick, asking Buildbucket for the build status
[23:47:40.038] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:40.038] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:69:0) after 1m0s
[23:48:40.321] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:69:0)
[23:48:40.321] Timer tick, asking Buildbucket for the build status
[23:48:40.417] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:40.417] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:70:0) after 1m0s
[23:49:40.722] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:70:0)
[23:49:40.722] Timer tick, asking Buildbucket for the build status
[23:49:40.794] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:40.794] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:71:0) after 1m0s
[23:50:41.316] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:71:0)
[23:50:41.316] Timer tick, asking Buildbucket for the build status
[23:50:41.383] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:41.383] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:72:0) after 1m0s
[23:51:41.565] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:72:0)
[23:51:41.565] Timer tick, asking Buildbucket for the build status
[23:51:41.638] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:41.638] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:73:0) after 1m0s
[23:52:41.653] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:73:0)
[23:52:41.653] Timer tick, asking Buildbucket for the build status
[23:52:43.141] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:43.141] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:74:0) after 1m0s
[23:53:43.462] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:74:0)
[23:53:43.462] Timer tick, asking Buildbucket for the build status
[23:53:43.548] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:43.548] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:75:0) after 1m0s
[23:54:43.712] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:75:0)
[23:54:43.712] Timer tick, asking Buildbucket for the build status
[23:54:43.794] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:43.794] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:76:0) after 1m0s
[23:55:44.052] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:76:0)
[23:55:44.052] Timer tick, asking Buildbucket for the build status
[23:55:44.128] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:44.128] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:77:0) after 1m0s
[23:56:44.255] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:77:0)
[23:56:44.255] Timer tick, asking Buildbucket for the build status
[23:56:44.434] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:44.434] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:78:0) after 1m0s
[23:57:44.438] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:78:0)
[23:57:44.438] Timer tick, asking Buildbucket for the build status
[23:57:46.169] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:46.169] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:79:0) after 1m0s
[23:58:46.411] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:79:0)
[23:58:46.411] Timer tick, asking Buildbucket for the build status
[23:58:48.339] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:48.339] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:80:0) after 1m0s
[23:59:48.461] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:80:0)
[23:59:48.461] Timer tick, asking Buildbucket for the build status
[23:59:48.567] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:48.567] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:81:0) after 1m0s
[00:00:48.628] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:81:0)
[00:00:48.628] Timer tick, asking Buildbucket for the build status
[00:00:48.704] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:48.704] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:82:0) after 1m0s
[00:01:48.843] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:82:0)
[00:01:48.843] Timer tick, asking Buildbucket for the build status
[00:01:48.973] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:48.973] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:83:0) after 1m0s
[00:02:49.090] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:83:0)
[00:02:49.090] Timer tick, asking Buildbucket for the build status
[00:02:49.456] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:49.456] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:84:0) after 1m0s
[00:03:49.615] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:84:0)
[00:03:49.615] Timer tick, asking Buildbucket for the build status
[00:03:49.761] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:49.761] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:85:0) after 1m0s
[00:04:49.927] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:85:0)
[00:04:49.927] Timer tick, asking Buildbucket for the build status
[00:04:50.018] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:50.018] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:86:0) after 1m0s
[00:05:50.044] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:86:0)
[00:05:50.044] Timer tick, asking Buildbucket for the build status
[00:05:50.120] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:50.120] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:87:0) after 1m0s
[00:06:50.217] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:87:0)
[00:06:50.217] Timer tick, asking Buildbucket for the build status
[00:06:50.362] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:50.362] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:88:0) after 1m0s
[00:07:50.366] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:88:0)
[00:07:50.366] Timer tick, asking Buildbucket for the build status
[00:07:50.605] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:50.605] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:89:0) after 1m0s
[00:08:50.691] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:89:0)
[00:08:50.691] Timer tick, asking Buildbucket for the build status
[00:08:50.775] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:50.775] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:90:0) after 1m0s
[00:09:50.873] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:90:0)
[00:09:50.873] Timer tick, asking Buildbucket for the build status
[00:09:51.119] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:51.119] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:91:0) after 1m0s
[00:10:51.135] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:91:0)
[00:10:51.135] Timer tick, asking Buildbucket for the build status
[00:10:51.218] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:51.218] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:92:0) after 1m0s
[00:11:51.277] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:92:0)
[00:11:51.277] Timer tick, asking Buildbucket for the build status
[00:11:51.424] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:51.424] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:93:0) after 1m0s
[00:12:51.516] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:93:0)
[00:12:51.516] Timer tick, asking Buildbucket for the build status
[00:12:51.628] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:51.628] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:94:0) after 1m0s
[00:13:51.654] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:94:0)
[00:13:51.654] Timer tick, asking Buildbucket for the build status
[00:13:51.743] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:51.743] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:95:0) after 1m0s
[00:14:51.784] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:95:0)
[00:14:51.784] Timer tick, asking Buildbucket for the build status
[00:14:51.874] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:51.874] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:96:0) after 1m0s
[00:15:51.894] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:96:0)
[00:15:51.894] Timer tick, asking Buildbucket for the build status
[00:15:52.151] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:52.151] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:97:0) after 1m0s
[00:16:52.231] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:97:0)
[00:16:52.231] Timer tick, asking Buildbucket for the build status
[00:16:52.330] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:52.330] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:98:0) after 1m0s
[00:17:52.347] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:98:0)
[00:17:52.347] Timer tick, asking Buildbucket for the build status
[00:17:52.447] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:52.447] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:99:0) after 1m0s
[00:18:52.436] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:99:0)
[00:18:52.437] Timer tick, asking Buildbucket for the build status
[00:18:52.525] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:52.525] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:100:0) after 1m0s
[00:19:52.611] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:100:0)
[00:19:52.611] Timer tick, asking Buildbucket for the build status
[00:19:52.699] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:52.699] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:101:0) after 1m0s
[00:20:52.766] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:101:0)
[00:20:52.766] Timer tick, asking Buildbucket for the build status
[00:20:53.351] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:53.351] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:102:0) after 1m0s
[00:21:53.458] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:102:0)
[00:21:53.458] Timer tick, asking Buildbucket for the build status
[00:21:53.840] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:53.840] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:103:0) after 1m0s
[00:22:53.905] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:103:0)
[00:22:53.905] Timer tick, asking Buildbucket for the build status
[00:22:54.011] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:54.011] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:104:0) after 1m0s
[00:23:54.247] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:104:0)
[00:23:54.247] Timer tick, asking Buildbucket for the build status
[00:23:54.334] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:54.334] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:105:0) after 1m0s
[00:24:54.467] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:105:0)
[00:24:54.467] Timer tick, asking Buildbucket for the build status
[00:24:54.565] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:54.565] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:106:0) after 1m0s
[00:25:54.991] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:106:0)
[00:25:54.991] Timer tick, asking Buildbucket for the build status
[00:25:55.095] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:55.095] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:107:0) after 1m0s
[00:26:55.256] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:107:0)
[00:26:55.256] Timer tick, asking Buildbucket for the build status
[00:26:55.349] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:55.349] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:108:0) after 1m0s
[00:27:55.585] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:108:0)
[00:27:55.585] Timer tick, asking Buildbucket for the build status
[00:27:55.930] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:55.930] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:109:0) after 1m0s
[00:28:55.969] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:109:0)
[00:28:55.969] Timer tick, asking Buildbucket for the build status
[00:28:56.068] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:56.068] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:110:0) after 1m0s
[00:29:56.076] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:110:0)
[00:29:56.076] Timer tick, asking Buildbucket for the build status
[00:29:56.155] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:56.155] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:111:0) after 1m0s
[00:30:56.133] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:111:0)
[00:30:56.133] Timer tick, asking Buildbucket for the build status
[00:30:56.198] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:56.198] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:112:0) after 1m0s
[00:31:56.210] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:112:0)
[00:31:56.210] Timer tick, asking Buildbucket for the build status
[00:31:56.351] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:56.351] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:113:0) after 1m0s
[00:32:56.363] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:113:0)
[00:32:56.363] Timer tick, asking Buildbucket for the build status
[00:32:56.460] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:56.460] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:114:0) after 1m0s
[00:33:56.483] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:114:0)
[00:33:56.483] Timer tick, asking Buildbucket for the build status
[00:33:56.669] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:56.669] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:115:0) after 1m0s
[00:34:56.718] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:115:0)
[00:34:56.718] Timer tick, asking Buildbucket for the build status
[00:34:56.805] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:56.805] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:116:0) after 1m0s
[00:35:56.841] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:116:0)
[00:35:56.841] Timer tick, asking Buildbucket for the build status
[00:35:56.919] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:56.919] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:117:0) after 1m0s
[00:36:56.940] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:117:0)
[00:36:56.940] Timer tick, asking Buildbucket for the build status
[00:36:57.154] Build 8853831963680918032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:57.155] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9019262025606417696:118:0) after 1m0s
[00:37:00.093] Received PubSub notification, asking Buildbucket for the build status
[00:37:00.339] Build 8853831963680918032: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[00:37:00.339] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1614731818398716",
"created_by": "project:chromium",
"created_ts": "1614724876668832",
"id": "8853831963680918032",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"133d88fb6be10eb7fa944b8cf5986ee93de6a6b6\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"jobs\": 500.0, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"133d88fb6be10eb7fa944b8cf5986ee93de6a6b6\", \"project\": \"chromium/src\"}], \"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-win10-32-1-qhp0\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.memory\", \"buildername\": \"win-asan\", \"buildnumber\": 17599, \"clang_revision\": \"llvmorg-13-init-1559-g01b87444-3\", \"got_angle_revision\": \"87b1875ca78afe9bf258287c5b8848e45df7dc10\", \"got_dawn_revision\": \"9b9e7b293e674bc62af385ed543f8775c9ee9f05\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"133d88fb6be10eb7fa944b8cf5986ee93de6a6b6\", \"got_revision_cp\": \"refs/heads/master@{#859151}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"106e01583a3ac2fb950777390dde2dcc31a8f161\", \"got_v8_revision\": \"12772c49b2417af1dba4f4469f249d377a01a676\", \"got_v8_revision_cp\": \"refs/heads/9.1.20@{#1}\", \"got_webrtc_revision\": \"07d83c8a9af02a0afc473503f75f150f23e3e0ff\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33366}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.win:win-asan\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"133d88fb6be10eb7fa944b8cf5986ee93de6a6b6\", \"swarm_hashes_refs/heads/master(at){#859151}_without_patch\": {\"absl_hardening_tests\": \"643e40acd98c99e30ad158feb162546c7aba3a33\", \"accessibility_unittests\": \"9952ef2f649df5668f49b09b8c3739f1e8c21f2d\", \"angle_unittests\": \"96387f64b1732a1c6648bfeceee9a6903724bddc\", \"app_shell_unittests\": \"99b1a7756f0d416fbd79a34b89fab91df4eab535\", \"aura_unittests\": \"5e0e50f2029dd2be22f49863317c300b171e89ec\", \"base_unittests\": \"3f2ca4fbbe71082b228390672ecc396a4b716ca0\", \"base_util_unittests\": \"a266165d03c2284e227fcdb4cc71c1564de2bd80\", \"blink_common_unittests\": \"cfc6289c0c0e97cbe62e817847a09ce96a4133cc\", \"blink_fuzzer_unittests\": \"e8374a29cb3d44e7f33a78bd0ea785fbb45b77b8\", \"blink_heap_unittests\": \"7f1425d3dcf5944fec24753eebd2fd76a5b60839\", \"blink_platform_unittests\": \"a6c69702a7c3d4b17c3a8f736a29e2c6779ad27d\", \"blink_unittests\": \"66fb578d5cf107fc0eedc510a5542962ba2e71b1\", \"boringssl_crypto_tests\": \"b7e49ec5ee56daddbf09dcedf178d469ef53f0ca\", \"boringssl_ssl_tests\": \"971880340ba99cdb9d2932f242bc8f0026e7bed6\", \"browser_switcher_bho_unittests\": \"0677c8a0213421fdd12148cb52705c4fa2ebffcf\", \"browser_tests\": \"c2bbd3855bbe5a3dea53c18620e84d91149874b3\", \"capture_unittests\": \"8d6fb416ff6ff3c128cb2ee2ca6071294c3b5813\", \"cast_unittests\": \"a14cca9521b98e0d3adb24fbdc63a5ce5da259d7\", \"cc_unittests\": \"6f37043f78964b2e5e6c0d9590f1562b0e664cc7\", \"chrome_app_unittests\": \"84c08a967bac0446ddf14036e9952e106c1057c3\", \"chrome_cleaner_unittests\": \"125b4c4185b3c9cd2d3739f696563ac9aaec8847\", \"chrome_elf_unittests\": \"b7ecac64fb4eb8bf8eda33d7f8c8387e8841f4b7\", \"chromedriver_unittests\": \"783fd2c89a830a1f666cf8acf6ed7cb4d8bd177b\", \"color_unittests\": \"d64e125472ce472518ee26ebe29f703e803c30d1\", \"components_browsertests\": \"f5bc2d9bda9626309a7630b44310487f27c501df\", \"components_unittests\": \"0a56e6815e8f910b86f7e691fe8dc58c5549edb0\", \"compositor_unittests\": \"eac5f7236c6839bb107d3852615ee449356c3d44\", \"content_browsertests\": \"16a1de84f1cf0ab38e093f080b9ebc4203846e4f\", \"content_unittests\": \"a09e35526fd292e666600b56787fb1ce22e22f25\", \"courgette_unittests\": \"07c5edcf11f2831cb208b6ea336c04fefcec90c8\", \"crashpad_tests\": \"56158de768c26def66c2be23d7256d36c8b655d4\", \"cronet_tests\": \"baf839f09d598871adcb71964165d81dcb69a054\", \"cronet_unittests\": \"e614357a85bafc15359eea06656718116e6d7685\", \"crypto_unittests\": \"b94a3cc1dd3d11dd14bdba23a476dd08e598b189\", \"delayloads_unittests\": \"d0a97248879db5ca962738a329e1d6848bba7d0b\", \"device_unittests\": \"b5a9e9b8e380c70d617a04f431c8fc078758d844\", \"display_unittests\": \"0b17625f5ee89d97e1255edd199c98e46afe85be\", \"elevation_service_unittests\": \"07f7fccad02ec24b74c19632d1f3b1fe1706f82e\", \"events_unittests\": \"eb32ef7609f64156603a0e48ebab04085b7959e7\", \"extensions_browsertests\": \"fa8f697af7da5a42d4542531af26683fb7bee61e\", \"extensions_unittests\": \"0a5a425da8e0ee7e046d740fc05d0067486ddd07\", \"filesystem_service_unittests\": \"40fbe21a2c56e7eacc9bcaf0dba2837327124f65\", \"gcm_unit_tests\": \"d06af34ed4b0a119c23614c193cc91055f94497e\", \"gcp_unittests\": \"02e1347bb275f38548f8adeb15beec26ecd70cbe\", \"gfx_unittests\": \"789ac59a5e80f6fc4165e9134153838458152b06\", \"gin_unittests\": \"40c65ed93715c0ad322fc8f8b13ac83c98dc483e\", \"google_apis_unittests\": \"46b289b0f7e0b5d4390085ab4222cdef0462a02c\", \"gpu_unittests\": \"abd129a809da7909cccdabc83fdd292f70307e20\", \"gwp_asan_unittests\": \"2451e24ec6ef1cd9d854882df7a60e782e6073e8\", \"headless_browsertests\": \"e568771963bb4919df38624e2d67a333da5ba68e\", \"headless_unittests\": \"a664ff1edbe6bee79aa3310df2175686592e2e83\", \"install_static_unittests\": \"7968a91eada813fbca19e1fd940ca550f0658c04\", \"installer_util_unittests\": \"1d478c5d49ebd23156d98fb4acd1dff892ecacdb\", \"interactive_ui_tests\": \"d051170c6469fcd59962944c0d8bca1c05b80e30\", \"ipc_tests\": \"09dbc45079c3eaf9e038085a8c7ef3354af5037a\", \"jingle_unittests\": \"976fcb343f4eba7eb4035b75c7e3bbca5061af47\", \"latency_unittests\": \"7ebd509dcef271af50a5ff411026da0bbb46bd0c\", \"libjingle_xmpp_unittests\": \"f58582d2598ba0ed8a559e594e36578b284ab397\", \"liburlpattern_unittests\": \"0864dbd95344a355e066d93a104cf0b60f18da5d\", \"media_blink_unittests\": \"4f7f6dd0dbe0354049ca7244282a2524b6fee2ca\", \"media_unittests\": \"43ecb6f0baefdd475c9f81beb94957d54a371a24\", \"message_center_unittests\": \"3b31f48f6be04dfc1da5237196df42a80a4fb022\", \"midi_unittests\": \"a6e420f52e7d8eb9108db3a7242a6a68e5749cbb\", \"mojo_core_unittests\": \"32cf828dfb95cff5a50dfad99b19deeadd1be19a\", \"mojo_unittests\": \"fd67673b0d3d6ddec1cc02457e3450ea1b09a6ad\", \"nacl_loader_unittests\": \"edcc81aa9fe84daf00c831c76c27a93cc4bc2e75\", \"native_theme_unittests\": \"2843907a90508f7c328c52ec5cac8558a2805ef3\", \"net_unittests\": \"d61edf6e295e9bb75ec6d411ba78877f6c51f532\", \"notification_helper_unittests\": \"c7ede788b7b93e30c285767b6ff8ebba47f3360b\", \"pdf_unittests\": \"b8d7b38082aa08c08ae55d803e2cb2998fb6e5d0\", \"perfetto_unittests\": \"db3ce267fb1811b0068208270007899d72da2a85\", \"ppapi_unittests\": \"40fd62fce87b0ca5e1f4c5b7d6ff6c2a2d6440b7\", \"printing_unittests\": \"53578568c4af57d3c3f8fab7c3f46e72bf9f5c46\", \"remoting_unittests\": \"e415a5189d759935111270ef817cc2e1ebc7c027\", \"sbox_integration_tests\": \"77df8b6d6c3cb5dba7e79bef0890bae4283dca08\", \"sbox_unittests\": \"1020384c38d258a0fb9f78e71f0dfc7206f921f6\", \"sbox_validation_tests\": \"fb77275c5e9576bdbe0c9c542320c6ffd42853ed\", \"service_manager_unittests\": \"ca0cc3e5f8698283af3991677a5b582e6231203c\", \"services_unittests\": \"283a2f3b9ddc4e57742848ed0f4eb948162c992d\", \"setup_unittests\": \"af3c18a9cbd80acff258c80f9c029e529c6fa60f\", \"shell_dialogs_unittests\": \"09c7c4488af4ca3c8c87c872095b45f5a5253d8d\", \"skia_unittests\": \"e209cb0acb8db60f9256e6cbfd5496e8c1479b6a\", \"snapshot_unittests\": \"3e3ab5e2d8cd2cfd341e48261c3863ac5030289e\", \"sql_unittests\": \"328e4e705059cb9d282a76ff62d245cd36c17c33\", \"storage_unittests\": \"ff3fffe371216e1222afeef16499403502e550e9\", \"sync_integration_tests\": \"556a8d752d59ff9c3c119526408892c0ebd76c83\", \"traffic_annotation_auditor_unittests\": \"ce4345b119d545849f34783ba8399b329f8a89f2\", \"ui_base_unittests\": \"f75926a90b9828162eb97ea823914c00797be972\", \"ui_touch_selection_unittests\": \"b89a8fde8e4f13a889789334a7418a717a5b2306\", \"unit_tests\": \"a7c2ff8fbe86bf3acc3f8279b8bfe29d6b2f3edf\", \"updater_tests\": \"b27edba836c9242c01a8b428d568782547e2a76a\", \"url_unittests\": \"63d3536fec707c085b7c07126ed6a66ba813a84b\", \"views_unittests\": \"c5f28d1a8a2f7bad9017ae1d7b6141801e4615cd\", \"viz_unittests\": \"a5eeea0cab3a5b1847289a17be37b22636f8cb44\", \"vr_common_unittests\": \"05be86a0864c5353ae352e21e5072d294eb144c9\", \"vr_pixeltests\": \"ee064baabd675af55c1292eea80c9fe57b656849\", \"weblayer_browsertests\": \"fd2704847ef4926a12b5319abe8499d487eb6fea\", \"weblayer_unittests\": \"0a5a643eb8e9c656ac4f27fbea7bddb98386769f\", \"wm_unittests\": \"a4520b55ffa49d0fea76b2d94ec307f4352cbbe9\", \"wtf_unittests\": \"16c3278aec2a9cbdff62cbad6e4e5b707817f0e7\", \"zlib_unittests\": \"ef873193abfe5ad4961bfd4b31e95582db0b3c69\", \"zucchini_unittests\": \"6c50a719b7b0629586b94d271345753d6cee6415\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_02613bacee8cd1c41158238da4ce7615021ecb28a4b52e6029f89cb601af0790_v2\", \"builder_c244a7c1904bb59c4b6cd021ade0aa3730bbe3d07abc076b32cf6cdc63527337_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-win10-32-1-qhp0\"], \"image\": [\"chrome-win10-1703-20111600-a937a23cefb\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"e2-standard-32\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"5725-1a0d85e\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1614724880998553",
"status": "COMPLETED",
"status_changed_ts": "1614731818918842",
"tags": [
"build_address:luci.chromium.ci/win-asan/17599",
"builder:win-asan",
"buildset:commit/git/133d88fb6be10eb7fa944b8cf5986ee93de6a6b6",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/133d88fb6be10eb7fa944b8cf5986ee93de6a6b6",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019262025606417696",
"scheduler_job_id:chromium/win-asan",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8853831963680918032/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Windows",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:520debd58eb8f910",
"user_agent:luci-scheduler"
],
"updated_ts": "1614731818991706",
"url": "https://ci.chromium.org/b/8853831963680918032",
"utcnow_ts": "1614731820316376"
}
}
[00:37:00.339] Invocation finished in 1h55m44.890885352s with status SUCCEEDED