[18:39:51.495] New invocation is queued and will start shortly
[18:39:52.794] Starting the invocation (attempt 1)
[18:39:52.856] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:39:52.857] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:39:52.857] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9029514670358537520",
"parameters_json": "{\"builder_name\":\"win-asan\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"2ce496624b860a6f9feb24d704e394ee272f8b70\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:win-asan",
"scheduler_invocation_id:9029514670358537520",
"scheduler_job_id:chromium/win-asan",
"user_agent:luci-scheduler",
"buildset:commit/git/2ce496624b860a6f9feb24d704e394ee272f8b70",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/2ce496624b860a6f9feb24d704e394ee272f8b70",
"gitiles_ref:refs/heads/master"
]
}
[18:39:54.007] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1604947193002387",
"id": "8864084608109499552",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"2ce496624b860a6f9feb24d704e394ee272f8b70\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1604947193699554",
"tags": [
"build_address:luci.chromium.ci/win-asan/15558",
"builder:win-asan",
"buildset:commit/git/2ce496624b860a6f9feb24d704e394ee272f8b70",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/2ce496624b860a6f9feb24d704e394ee272f8b70",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9029514670358537520",
"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/8864084608109499552/+/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": "1604947193700341",
"url": "https://ci.chromium.org/b/8864084608109499552",
"utcnow_ts": "1604947193996495"
}
}
[18:39:54.007] Task URL: https://ci.chromium.org/b/8864084608109499552
[18:39:54.007] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:2:0) after 1m0s
[18:40:02.889] Received PubSub notification, asking Buildbucket for the build status
[18:40:03.029] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:40:54.082] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:2:0)
[18:40:54.082] Timer tick, asking Buildbucket for the build status
[18:40:54.175] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:40:54.175] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:4:0) after 1m0s
[18:41:54.238] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:4:0)
[18:41:54.238] Timer tick, asking Buildbucket for the build status
[18:41:54.734] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:41:54.734] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:5:0) after 1m0s
[18:42:54.906] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:5:0)
[18:42:54.906] Timer tick, asking Buildbucket for the build status
[18:42:55.217] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:42:55.217] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:6:0) after 1m0s
[18:43:55.465] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:6:0)
[18:43:55.465] Timer tick, asking Buildbucket for the build status
[18:43:55.609] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:43:55.609] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:7:0) after 1m0s
[18:44:55.638] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:7:0)
[18:44:55.638] Timer tick, asking Buildbucket for the build status
[18:44:56.049] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:44:56.049] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:8:0) after 1m0s
[18:45:56.202] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:8:0)
[18:45:56.202] Timer tick, asking Buildbucket for the build status
[18:45:56.827] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:45:56.827] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:9:0) after 1m0s
[18:46:56.909] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:9:0)
[18:46:56.909] Timer tick, asking Buildbucket for the build status
[18:46:58.290] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:46:58.290] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:10:0) after 1m0s
[18:47:58.402] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:10:0)
[18:47:58.402] Timer tick, asking Buildbucket for the build status
[18:47:58.476] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:58.476] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:11:0) after 1m0s
[18:48:58.545] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:11:0)
[18:48:58.545] Timer tick, asking Buildbucket for the build status
[18:48:58.609] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:48:58.609] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:12:0) after 1m0s
[18:49:58.706] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:12:0)
[18:49:58.706] Timer tick, asking Buildbucket for the build status
[18:49:59.086] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:49:59.086] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:13:0) after 1m0s
[18:50:59.138] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:13:0)
[18:50:59.138] Timer tick, asking Buildbucket for the build status
[18:50:59.382] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:59.382] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:14:0) after 1m0s
[18:51:59.443] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:14:0)
[18:51:59.443] Timer tick, asking Buildbucket for the build status
[18:51:59.567] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:51:59.567] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:15:0) after 1m0s
[18:52:59.611] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:15:0)
[18:52:59.611] Timer tick, asking Buildbucket for the build status
[18:52:59.778] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:52:59.778] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:16:0) after 1m0s
[18:53:59.840] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:16:0)
[18:53:59.840] Timer tick, asking Buildbucket for the build status
[18:54:00.396] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:54:00.396] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:17:0) after 1m0s
[18:55:00.424] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:17:0)
[18:55:00.424] Timer tick, asking Buildbucket for the build status
[18:55:00.526] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:55:00.526] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:18:0) after 1m0s
[18:56:01.197] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:18:0)
[18:56:01.197] Timer tick, asking Buildbucket for the build status
[18:56:01.353] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:56:01.353] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:19:0) after 1m0s
[18:57:01.681] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:19:0)
[18:57:01.681] Timer tick, asking Buildbucket for the build status
[18:57:01.942] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:57:01.942] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:20:0) after 1m0s
[18:58:01.960] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:20:0)
[18:58:01.960] Timer tick, asking Buildbucket for the build status
[18:58:02.112] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:02.112] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:21:0) after 1m0s
[18:59:02.161] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:21:0)
[18:59:02.161] Timer tick, asking Buildbucket for the build status
[18:59:02.299] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:59:02.299] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:22:0) after 1m0s
[19:00:02.340] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:22:0)
[19:00:02.340] Timer tick, asking Buildbucket for the build status
[19:00:02.927] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:00:02.927] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:23:0) after 1m0s
[19:01:03.031] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:23:0)
[19:01:03.031] Timer tick, asking Buildbucket for the build status
[19:01:03.632] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:01:03.632] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:24:0) after 1m0s
[19:02:03.667] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:24:0)
[19:02:03.667] Timer tick, asking Buildbucket for the build status
[19:02:04.007] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:02:04.007] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:25:0) after 1m0s
[19:03:04.052] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:25:0)
[19:03:04.052] Timer tick, asking Buildbucket for the build status
[19:03:04.604] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:03:04.604] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:26:0) after 1m0s
[19:04:04.641] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:26:0)
[19:04:04.641] Timer tick, asking Buildbucket for the build status
[19:04:04.855] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:04:04.855] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:27:0) after 1m0s
[19:05:04.892] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:27:0)
[19:05:04.892] Timer tick, asking Buildbucket for the build status
[19:05:05.260] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:05:05.260] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:28:0) after 1m0s
[19:06:05.315] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:28:0)
[19:06:05.315] Timer tick, asking Buildbucket for the build status
[19:06:05.540] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:06:05.540] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:29:0) after 1m0s
[19:07:05.684] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:29:0)
[19:07:05.684] Timer tick, asking Buildbucket for the build status
[19:07:06.789] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:07:06.789] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:30:0) after 1m0s
[19:08:08.888] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:30:0)
[19:08:08.888] Timer tick, asking Buildbucket for the build status
[19:08:09.061] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:08:09.061] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:31:0) after 1m0s
[19:09:09.134] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:31:0)
[19:09:09.134] Timer tick, asking Buildbucket for the build status
[19:09:11.624] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:09:11.625] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:32:0) after 1m0s
[19:10:11.725] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:32:0)
[19:10:11.725] Timer tick, asking Buildbucket for the build status
[19:10:11.925] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:10:11.925] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:33:0) after 1m0s
[19:11:11.988] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:33:0)
[19:11:11.988] Timer tick, asking Buildbucket for the build status
[19:11:12.159] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:11:12.159] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:34:0) after 1m0s
[19:12:12.243] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:34:0)
[19:12:12.243] Timer tick, asking Buildbucket for the build status
[19:12:12.374] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:12:12.374] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:35:0) after 1m0s
[19:13:12.481] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:35:0)
[19:13:12.481] Timer tick, asking Buildbucket for the build status
[19:13:12.605] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:13:12.605] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:36:0) after 1m0s
[19:14:12.722] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:36:0)
[19:14:12.722] Timer tick, asking Buildbucket for the build status
[19:14:13.248] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:14:13.248] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:37:0) after 1m0s
[19:15:13.363] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:37:0)
[19:15:13.363] Timer tick, asking Buildbucket for the build status
[19:15:13.938] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:15:13.938] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:38:0) after 1m0s
[19:16:14.040] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:38:0)
[19:16:14.040] Timer tick, asking Buildbucket for the build status
[19:16:14.136] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:16:14.136] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:39:0) after 1m0s
[19:17:14.183] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:39:0)
[19:17:14.183] Timer tick, asking Buildbucket for the build status
[19:17:14.295] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:17:14.295] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:40:0) after 1m0s
[19:18:14.669] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:40:0)
[19:18:14.669] Timer tick, asking Buildbucket for the build status
[19:18:14.836] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:18:14.836] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:41:0) after 1m0s
[19:19:15.131] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:41:0)
[19:19:15.131] Timer tick, asking Buildbucket for the build status
[19:19:15.262] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:19:15.262] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:42:0) after 1m0s
[19:20:15.733] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:42:0)
[19:20:15.733] Timer tick, asking Buildbucket for the build status
[19:20:16.386] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:20:16.386] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:43:0) after 1m0s
[19:21:16.767] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:43:0)
[19:21:16.767] Timer tick, asking Buildbucket for the build status
[19:21:16.926] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:21:16.926] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:44:0) after 1m0s
[19:22:17.418] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:44:0)
[19:22:17.418] Timer tick, asking Buildbucket for the build status
[19:22:17.531] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:22:17.531] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:45:0) after 1m0s
[19:23:17.634] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:45:0)
[19:23:17.634] Timer tick, asking Buildbucket for the build status
[19:23:17.877] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:23:17.877] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:46:0) after 1m0s
[19:24:17.933] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:46:0)
[19:24:17.933] Timer tick, asking Buildbucket for the build status
[19:24:18.122] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:24:18.122] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:47:0) after 1m0s
[19:25:18.222] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:47:0)
[19:25:18.222] Timer tick, asking Buildbucket for the build status
[19:25:18.365] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:25:18.365] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:48:0) after 1m0s
[19:26:18.460] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:48:0)
[19:26:18.460] Timer tick, asking Buildbucket for the build status
[19:26:18.600] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:26:18.600] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:49:0) after 1m0s
[19:27:18.745] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:49:0)
[19:27:18.745] Timer tick, asking Buildbucket for the build status
[19:27:18.951] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:27:18.951] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:50:0) after 1m0s
[19:28:19.255] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:50:0)
[19:28:19.255] Timer tick, asking Buildbucket for the build status
[19:28:19.454] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:28:19.454] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:51:0) after 1m0s
[19:29:19.491] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:51:0)
[19:29:19.491] Timer tick, asking Buildbucket for the build status
[19:29:19.599] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:29:19.599] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:52:0) after 1m0s
[19:30:19.721] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:52:0)
[19:30:19.721] Timer tick, asking Buildbucket for the build status
[19:30:20.155] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:30:20.155] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:53:0) after 1m0s
[19:31:20.234] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:53:0)
[19:31:20.234] Timer tick, asking Buildbucket for the build status
[19:31:20.328] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:31:20.328] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:54:0) after 1m0s
[19:32:20.454] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:54:0)
[19:32:20.454] Timer tick, asking Buildbucket for the build status
[19:32:20.536] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:32:20.536] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:55:0) after 1m0s
[19:33:20.715] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:55:0)
[19:33:20.715] Timer tick, asking Buildbucket for the build status
[19:33:20.801] Build 8864084608109499552: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:33:20.801] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029514670358537520:56:0) after 1m0s
[19:33:54.439] Received PubSub notification, asking Buildbucket for the build status
[19:33:54.747] Build 8864084608109499552: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[19:33:54.747] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1604950433015189",
"created_by": "project:chromium",
"created_ts": "1604947193002387",
"failure_reason": "BUILD_FAILURE",
"id": "8864084608109499552",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"2ce496624b860a6f9feb24d704e394ee272f8b70\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed.\"}, \"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\": \"2ce496624b860a6f9feb24d704e394ee272f8b70\", \"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-8-b9eu\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.memory\", \"buildername\": \"win-asan\", \"buildnumber\": 15558, \"clang_revision\": \"llvmorg-12-init-11060-g118c3f3c-1\", \"got_angle_revision\": \"40c5e53e7bbab464d547daedd3200c7240835e8d\", \"got_dawn_revision\": \"3e17e33724b4d0b4c4fc1985340882e1f543e3a0\", \"got_nacl_revision\": \"f9e6f257d1a0934dbeed3c5c8f83b651dc4f55e1\", \"got_revision\": \"2ce496624b860a6f9feb24d704e394ee272f8b70\", \"got_revision_cp\": \"refs/heads/master@{#825390}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"4ed9d3498dcffa987acba1a8007ff8dec336f263\", \"got_v8_revision\": \"b4a39160e51f21c446e5b042ae88603ea1f7b7d8\", \"got_v8_revision_cp\": \"refs/heads/8.8.262@{#1}\", \"got_webrtc_revision\": \"9c99b7964fabb16a022293ffbd2804f9b46551f6\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32565}\", \"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\": \"2ce496624b860a6f9feb24d704e394ee272f8b70\", \"swarm_hashes_refs/heads/master(at){#825390}_without_patch\": {\"absl_hardening_tests\": \"bb98f9756b5d221fa77df1da4384a8c8a148b97c\", \"accessibility_unittests\": \"a69875e9b43de619c0c444842ddefb83c5f1a03a\", \"angle_unittests\": \"5c1fe2aff629399abf1367e97e7d2059757c159e\", \"app_shell_unittests\": \"5bf84369b71643a978882449eb1e2a9ec195755a\", \"aura_unittests\": \"06a8893d255a2b2938b4bcf6c724328dca69be93\", \"base_unittests\": \"7583e6b1b0c0f05a94bbc2d867c757073ef499e0\", \"base_util_unittests\": \"c81d8e93730033df1f101c99f2bc601d98821c67\", \"blink_common_unittests\": \"91dffcb4c8af3f58a5946460f68142782c121378\", \"blink_fuzzer_unittests\": \"2897c0ce83b3ce0a9c2e4b5b0ca85406b02d1a9e\", \"blink_heap_unittests\": \"e0cb23f68255a0b453860201ab22c01a431d63fc\", \"blink_platform_unittests\": \"d8365300587ce631a094bf921399ba244bfb3f1f\", \"blink_unittests\": \"3b40615d41c0f9a6b11bccbb33c727dcb8b1958d\", \"boringssl_crypto_tests\": \"fa0eada8623a87a911a087c1d01f7b29bad9f30a\", \"boringssl_ssl_tests\": \"89639dc90737f8b721e7579e45ed93446d78e7ca\", \"browser_switcher_bho_unittests\": \"d379f5e09529ddc3de6314f3237951a69baaf5f0\", \"browser_tests\": \"982c181b18701888192faa31b5616ad752809fd4\", \"capture_unittests\": \"674f37ec7e8ea768955ca5ca1d211cced4b5e9d8\", \"cast_unittests\": \"7bae11c176b413348925f308642aa55fe5e224a5\", \"cc_unittests\": \"1b199e46bddf98b4143bcb291a3cca2eefaf4846\", \"chrome_app_unittests\": \"caf58ef56e7743b7fc217e29d072029a6d70c5fb\", \"chrome_cleaner_unittests\": \"1753b90591d2cf7548fdf96e0cd5a2645c8a21bc\", \"chrome_elf_unittests\": \"b5d09184d1aee1f4d1a9ef63d0840a67b4c24861\", \"chromedriver_unittests\": \"7494aa037dec948e22464745c728d1c3fff2615b\", \"components_browsertests\": \"29d01a7b731855fe15b0538f17e7d9fb4d2362e6\", \"components_unittests\": \"71a0f8d8cc3e458d30802e4db2e70a2ad6331995\", \"compositor_unittests\": \"fa96e9de699c1444d331376d3dd56c645315a18b\", \"content_browsertests\": \"cb984e60b028a5e3bbecf81f3bfe64812c5ea8f3\", \"content_unittests\": \"34531578a089cd7851dd4f461628cb7719e3527f\", \"courgette_unittests\": \"04d3a3e7906b25a9f4c07ad52106c260f314f2bc\", \"crashpad_tests\": \"eee804fe41e2256de003015e943ba8cc6d40b125\", \"cronet_tests\": \"49001d4660da1b1a4e8e8737620f83ce379a26bd\", \"cronet_unittests\": \"998a09403a84dce76c583ce37f392b43bfe4353c\", \"crypto_unittests\": \"2a9332701c29d5f54a18b57d6a505f819ea57885\", \"delayloads_unittests\": \"bd548b4c2589730d1b21455ad9e9656a612c382b\", \"device_unittests\": \"dfd004df8c9d55d827710eaa4849c161c15be064\", \"display_unittests\": \"6b50df8855c9543fea4464d93530365357c03072\", \"elevation_service_unittests\": \"80f4b18c4115c64ac37103e0dbcf5f4053428f35\", \"events_unittests\": \"4589d84f3df10eb8d8c97a7408f5b6e08c1e80f1\", \"extensions_browsertests\": \"d0a36e8d90bef446f42933bba5d7e2210791d248\", \"extensions_unittests\": \"0d85015ba75fbc3468f54999821717aea117ab1f\", \"filesystem_service_unittests\": \"811ff8d6a5db2a9e6047334b96c29a2e7c1fd0a8\", \"gcm_unit_tests\": \"c3d4959d2d5eaf2c0fd62c6d1a5d3fdeaad65ea2\", \"gcp_unittests\": \"bb879f32b461be365e302e1dc9e73d386e662c9c\", \"gfx_unittests\": \"8dd4a90eb7b0fc599eafafdeea91dddd3bccbb3e\", \"gin_unittests\": \"d79469ca32ec474577e6300e92dbd1e3b9a43f69\", \"google_apis_unittests\": \"5846aa87cefb4f3d8c771992de0e81f8ddf9c3d7\", \"gpu_unittests\": \"4b00abed9d9ace3863489d764fa7061b77ae7884\", \"gwp_asan_unittests\": \"8be87148424d7c441e1149ea70682d63f6b11f31\", \"headless_browsertests\": \"2f515ced688ec1bcc7489508a9cc09410696dc57\", \"headless_unittests\": \"eac69afdd8c2629983c822676a9de832a8b521c2\", \"install_static_unittests\": \"dc69be8bd2c1ee9022c250f1b2cc9ede72aae893\", \"installer_util_unittests\": \"b63c2926d5cd272b688c1445a4a1dcb8c114ed10\", \"interactive_ui_tests\": \"7663f63ef9fd932d53d22dd28c88a308763108c5\", \"ipc_tests\": \"b965845426148aa61b90a35528ac6820ef8cd633\", \"jingle_unittests\": \"3d09c70f573ff0b10a342b976b84f5e8eeeb7403\", \"latency_unittests\": \"deab89462b7a1ac439cddaca0f1855f9619b558c\", \"libjingle_xmpp_unittests\": \"1c78c0c772e72dedc22e23d4eedc106fb995a307\", \"liburlpattern_unittests\": \"238e32a9f6cb2d1bc58223e56512341bec44a4ff\", \"media_blink_unittests\": \"0f8cd2d21f3c28c126756af281322aa2d8f4e4d9\", \"media_unittests\": \"c001eee6a4d3dff402a8b9511e4a79fc96d57515\", \"message_center_unittests\": \"9c7a0a5ece8793838c66290c60391486c577e5be\", \"midi_unittests\": \"690982c35ff68ae93a77c960ea31459182af2cc1\", \"mojo_core_unittests\": \"be801c8801e69230c21f5580d72a220103fa4176\", \"mojo_unittests\": \"028b94a49150ed7d99e4f65f3a8ca932b67f3f44\", \"nacl_loader_unittests\": \"3dec696cf829b6f96ef5b290d997246cbe755c7c\", \"native_theme_unittests\": \"a6aaa6fd8e72242a830f209df4d3db371aab946c\", \"net_unittests\": \"8b09c923727a0c29e3dd357c443a87d682aaeec8\", \"notification_helper_unittests\": \"73e0d18c24ed1b3b9808699b4a8d175e84d060d0\", \"pdf_unittests\": \"94acf694940a660a320fae35822212c076cf0a46\", \"perfetto_unittests\": \"3c326f46d3a280b5c7347ae317b06b897f8773c2\", \"ppapi_unittests\": \"919d1ad4ef05774b176f25f9471ecb8408aa68a8\", \"printing_unittests\": \"40a5d8d1f39324e3660225476849c28206b59fbc\", \"remoting_unittests\": \"56a7e1bbc9b2deb30d3f52a76e7cf9d4e38269da\", \"sbox_integration_tests\": \"f02fa13e873fd171e5a5e880ddf7b673604a829e\", \"sbox_unittests\": \"c4bfa1fcb630f9febece6cfb7a426ad01c94b80d\", \"sbox_validation_tests\": \"4b723b6a8269240848f12f34b21f222790b7b09a\", \"service_manager_unittests\": \"02d41b1d2fd1727314f3739c3dca43015802e927\", \"services_unittests\": \"d89e6fbeaa0f55234a2968b674c7e1e45d3e36c9\", \"setup_unittests\": \"002c69e6f909f8d5d4d1025bd201a40116575439\", \"shell_dialogs_unittests\": \"2bf9e543886f00315391ca50fe1a798dc29ff216\", \"skia_unittests\": \"6a2193f5f8f1e44c774db3aa8493b0481f414b43\", \"snapshot_unittests\": \"e2803c5f4d98b861f0f54b5ad8dbba02e3cf0411\", \"sql_unittests\": \"25125c132f3c3677c96881762213beaa221a98fd\", \"storage_unittests\": \"61085dde9f9dfd5c99828dab6fbc0e771ac92e88\", \"sync_integration_tests\": \"eb55d22b30ce8dbcaa0ab4ad22d11bfd78bb5366\", \"traffic_annotation_auditor_unittests\": \"4db552d45ae977b4c994934bf35c13a4140035f7\", \"ui_base_unittests\": \"64f773270a42136be399fe7ffda1bbe5fcbfc857\", \"ui_touch_selection_unittests\": \"1b9e8221052cbb5f762eba84979967f84b20b089\", \"unit_tests\": \"3995da505a2a955d47963b96e85a638a115780c6\", \"updater_tests\": \"5943f08e003661f351e907c1016247b456f07758\", \"url_unittests\": \"5ec8b520414fa9acc81ea9e55a3909fd94a823c9\", \"views_unittests\": \"3a6901b47278412970e7082417b0e88af67b7a68\", \"viz_unittests\": \"b1f93fdf190c5145e2e36bca284b2d81c9cd4365\", \"vr_common_unittests\": \"ca9aabb3488e8cf7a1a48bc8ba960a8d37506a8d\", \"vr_pixeltests\": \"240ec7fc81213ef875082573974c2f7252b54622\", \"weblayer_browsertests\": \"31026687c9a41a54c106fb86c89ce412121971a3\", \"weblayer_unittests\": \"234d1bd233113feccb8dba16f68b808281d487ec\", \"wm_unittests\": \"9af64dfe06298b7ce32070daf2d1d3ac9fd33d86\", \"wtf_unittests\": \"ba93d09f57f95f1b7532b40fbe24ced0a6a2d501\", \"zlib_unittests\": \"635c6d419d32ac4464efceb833d93f0548f918e4\", \"zucchini_unittests\": \"4efb024d8b3dbefc5d4da5c92763089b7c092554\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"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-8-b9eu\"], \"image\": [\"chrome-win10-1703-20092300-22ba5320847\"], \"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\": [\"5626-39642e9\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed.\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1604947201961389",
"status": "COMPLETED",
"status_changed_ts": "1604947202292480",
"tags": [
"build_address:luci.chromium.ci/win-asan/15558",
"builder:win-asan",
"buildset:commit/git/2ce496624b860a6f9feb24d704e394ee272f8b70",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/2ce496624b860a6f9feb24d704e394ee272f8b70",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9029514670358537520",
"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/8864084608109499552/+/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:4fc7204ad3b63f10",
"user_agent:luci-scheduler"
],
"updated_ts": "1604950434207003",
"url": "https://ci.chromium.org/b/8864084608109499552",
"utcnow_ts": "1604950434721341"
}
}
[19:33:54.748] Invocation finished in 54m3.274555623s with status FAILED