[15:13:28.939] New invocation is queued and will start shortly
[15:13:30.457] Starting the invocation (attempt 1)
[15:13:30.487] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e9d66695565d4e3b6041116fd27dfbf933393b24"
[15:13:30.487] Popped gitiles commit info from properties and tags
[15:13:30.487] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[15:13:30.489] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[15:13:30.490] Buildbucket request:
{
"requestId": "8897980859189598848",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win-fieldtrial-rel"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "e9d66695565d4e3b6041116fd27dfbf933393b24",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8897980859189598848"
},
{
"key": "scheduler_job_id",
"value": "chromium/win-fieldtrial-rel"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[15:13:31.039] Scheduled build:
{
"id": "8732550796832790497",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win-fieldtrial-rel"
},
"number": 12298,
"createdBy": "project:chromium",
"createTime": "2024-10-31T15:13:30.555452093Z",
"updateTime": "2024-10-31T15:13:30.555452093Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "e9d66695565d4e3b6041116fd27dfbf933393b24",
"ref": "refs/heads/main"
}
}
}
[15:13:31.039] Task URL: https://cr-buildbucket.appspot.com/build/8732550796832790497
[15:13:31.039] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:2:0) after 4m59s
[15:13:32.020] Received PubSub notification, asking Buildbucket for the build status
[15:13:32.039] Build status: SCHEDULED
[15:15:10.270] Received PubSub notification, asking Buildbucket for the build status
[15:15:10.299] Build status: STARTED
[15:18:30.057] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:2:0)
[15:18:30.088] Build status: STARTED
[15:18:30.088] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:5:0) after 3m30s
[15:22:00.155] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:5:0)
[15:22:00.179] Build status: STARTED
[15:22:00.179] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:6:0) after 5m59s
[15:27:59.186] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:6:0)
[15:27:59.205] Build status: STARTED
[15:27:59.205] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:7:0) after 2m19s
[15:30:18.268] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:7:0)
[15:30:18.308] Build status: STARTED
[15:30:18.308] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:8:0) after 7m2s
[15:37:20.353] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:8:0)
[15:37:20.372] Build status: STARTED
[15:37:20.372] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:9:0) after 9m7s
[15:46:27.460] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:9:0)
[15:46:27.485] Build status: STARTED
[15:46:27.485] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:10:0) after 4m23s
[15:50:50.475] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:10:0)
[15:50:50.498] Build status: STARTED
[15:50:50.499] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:11:0) after 8m39s
[15:59:29.526] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:11:0)
[15:59:29.544] Build status: STARTED
[15:59:29.544] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:12:0) after 3m46s
[16:03:15.520] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:12:0)
[16:03:15.539] Build status: STARTED
[16:03:15.539] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:13:0) after 4m45s
[16:08:00.560] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:13:0)
[16:08:00.615] Build status: STARTED
[16:08:00.615] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:14:0) after 6m24s
[16:14:24.610] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:14:0)
[16:14:24.627] Build status: STARTED
[16:14:24.627] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:15:0) after 2m20s
[16:16:44.645] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:15:0)
[16:16:44.668] Build status: STARTED
[16:16:44.668] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:16:0) after 1m42s
[16:18:26.737] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:16:0)
[16:18:26.754] Build status: STARTED
[16:18:26.754] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:17:0) after 4m2s
[16:22:28.746] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:17:0)
[16:22:28.766] Build status: STARTED
[16:22:28.766] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:18:0) after 6m11s
[16:28:39.788] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:18:0)
[16:28:39.809] Build status: STARTED
[16:28:39.809] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:19:0) after 1m56s
[16:30:35.902] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:19:0)
[16:30:35.933] Build status: STARTED
[16:30:35.933] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:20:0) after 8m8s
[16:38:44.053] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:20:0)
[16:38:44.105] Build status: STARTED
[16:38:44.105] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:21:0) after 4m19s
[16:43:03.126] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:21:0)
[16:43:03.143] Build status: STARTED
[16:43:03.143] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:22:0) after 4m22s
[16:47:25.213] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:22:0)
[16:47:25.236] Build status: STARTED
[16:47:25.236] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:23:0) after 2m27s
[16:49:52.253] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:23:0)
[16:49:52.280] Build status: STARTED
[16:49:52.280] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:24:0) after 9m5s
[16:58:57.355] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:24:0)
[16:58:57.383] Build status: STARTED
[16:58:57.383] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:25:0) after 8m39s
[17:07:36.515] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:25:0)
[17:07:36.536] Build status: STARTED
[17:07:36.536] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:26:0) after 7m49s
[17:15:25.573] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:26:0)
[17:15:25.590] Build status: STARTED
[17:15:25.590] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:27:0) after 6m41s
[17:22:06.656] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:27:0)
[17:22:06.688] Build status: STARTED
[17:22:06.688] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:28:0) after 1m59s
[17:24:05.720] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:28:0)
[17:24:05.739] Build status: STARTED
[17:24:05.740] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:29:0) after 5m30s
[17:29:35.739] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:29:0)
[17:29:35.753] Build status: STARTED
[17:29:35.753] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:30:0) after 3m34s
[17:33:09.910] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:30:0)
[17:33:09.932] Build status: STARTED
[17:33:09.932] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:31:0) after 4m48s
[17:37:57.946] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:31:0)
[17:37:57.974] Build status: STARTED
[17:37:57.974] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:32:0) after 4m10s
[17:42:08.002] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:32:0)
[17:42:08.022] Build status: STARTED
[17:42:08.022] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:33:0) after 2m39s
[17:44:47.042] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:33:0)
[17:44:47.126] Build status: STARTED
[17:44:47.126] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:34:0) after 5m30s
[17:50:17.238] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:34:0)
[17:50:17.262] Build status: STARTED
[17:50:17.262] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:35:0) after 7m9s
[17:57:26.279] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:35:0)
[17:57:26.300] Build status: STARTED
[17:57:26.300] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:36:0) after 2m22s
[17:59:48.349] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:36:0)
[17:59:48.387] Build status: STARTED
[17:59:48.387] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:37:0) after 3m35s
[18:03:23.411] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:37:0)
[18:03:23.433] Build status: STARTED
[18:03:23.433] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:38:0) after 7m39s
[18:11:02.463] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:38:0)
[18:11:02.482] Build status: STARTED
[18:11:02.482] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:39:0) after 2m49s
[18:13:51.490] Handling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:39:0)
[18:13:51.509] Build status: STARTED
[18:13:51.509] Scheduling timer "check-buildbucket-build-status" (chromium/win-fieldtrial-rel:8897980859189598848:40:0) after 9m13s
[18:17:36.958] Received PubSub notification, asking Buildbucket for the build status
[18:17:37.047] Build:
{
"id": "8732550796832790497",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win-fieldtrial-rel"
},
"number": 12298,
"createdBy": "project:chromium",
"createTime": "2024-10-31T15:13:30.555452093Z",
"startTime": "2024-10-31T15:15:10.039745961Z",
"endTime": "2024-10-31T18:17:36.483079291Z",
"updateTime": "2024-10-31T18:17:36.483079291Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "e9d66695565d4e3b6041116fd27dfbf933393b24",
"ref": "refs/heads/main"
}
}
}
[18:17:37.047] Invocation finished in 3h4m8.123413811s with status FAILED