[14:01:06.192] New invocation is queued and will start shortly
[14:01:07.309] Starting the invocation (attempt 1)
[14:01:07.359] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a4279f28422a0b59acdc9fcfe7233d9f0e3b2dc6"
[14:01:07.359] Popped gitiles commit info from properties and tags
[14:01:07.359] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[14:01:07.363] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[14:01:07.364] Buildbucket request:
{
"requestId": "8921631221118288448",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "android-arm64-proguard-rel"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "a4279f28422a0b59acdc9fcfe7233d9f0e3b2dc6",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8921631221118288448"
},
{
"key": "scheduler_job_id",
"value": "chromium/android-arm64-proguard-rel"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[14:01:08.031] Scheduled build:
{
"id": "8756201159139046209",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "android-arm64-proguard-rel"
},
"number": 10000,
"createdBy": "project:chromium",
"createTime": "2024-02-13T14:01:07.450771361Z",
"updateTime": "2024-02-13T14:01:07.450771361Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "a4279f28422a0b59acdc9fcfe7233d9f0e3b2dc6",
"ref": "refs/heads/main"
}
}
}
[14:01:08.034] Task URL: https://cr-buildbucket.appspot.com/build/8756201159139046209
[14:01:08.039] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:2:0) after 9m0s
[14:01:14.271] Received PubSub notification, asking Buildbucket for the build status
[14:01:14.366] Build status: SCHEDULED
[14:01:59.512] Received PubSub notification, asking Buildbucket for the build status
[14:01:59.537] Build status: STARTED
[14:10:08.109] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:2:0)
[14:10:08.145] Build status: STARTED
[14:10:08.145] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:5:0) after 7m30s
[14:17:38.202] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:5:0)
[14:17:38.234] Build status: STARTED
[14:17:38.234] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:6:0) after 3m50s
[14:21:28.624] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:6:0)
[14:21:28.646] Build status: STARTED
[14:21:28.646] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:7:0) after 4m40s
[14:26:08.895] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:7:0)
[14:26:08.988] Build status: STARTED
[14:26:08.988] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:8:0) after 7m51s
[14:34:00.006] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:8:0)
[14:34:00.029] Build status: STARTED
[14:34:00.029] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:9:0) after 3m19s
[14:37:19.117] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:9:0)
[14:37:19.138] Build status: STARTED
[14:37:19.138] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:10:0) after 9m23s
[14:46:42.213] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:10:0)
[14:46:42.236] Build status: STARTED
[14:46:42.236] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:11:0) after 4m53s
[14:51:35.258] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:11:0)
[14:51:35.279] Build status: STARTED
[14:51:35.279] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:12:0) after 8m49s
[15:00:24.545] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:12:0)
[15:00:24.583] Build status: STARTED
[15:00:24.583] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:13:0) after 4m18s
[15:04:42.606] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:13:0)
[15:04:42.702] Build status: STARTED
[15:04:42.702] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:14:0) after 9m25s
[15:14:07.759] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:14:0)
[15:14:07.827] Build status: STARTED
[15:14:07.827] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:15:0) after 5m29s
[15:19:36.821] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:15:0)
[15:19:36.961] Build status: STARTED
[15:19:36.961] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:16:0) after 5m1s
[15:24:38.036] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:16:0)
[15:24:38.071] Build status: STARTED
[15:24:38.071] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:17:0) after 2m42s
[15:27:20.094] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:17:0)
[15:27:20.126] Build status: STARTED
[15:27:20.126] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:18:0) after 5m31s
[15:32:51.292] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:18:0)
[15:32:51.318] Build status: STARTED
[15:32:51.318] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:19:0) after 6m35s
[15:39:26.376] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:19:0)
[15:39:26.394] Build status: STARTED
[15:39:26.394] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:20:0) after 4m28s
[15:43:54.883] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:20:0)
[15:43:54.904] Build status: STARTED
[15:43:54.904] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:21:0) after 1m33s
[15:45:28.026] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:21:0)
[15:45:28.042] Build status: STARTED
[15:45:28.042] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:22:0) after 7m12s
[15:52:40.067] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:22:0)
[15:52:40.104] Build status: STARTED
[15:52:40.104] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:23:0) after 7m1s
[15:59:41.245] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:23:0)
[15:59:41.318] Build status: STARTED
[15:59:41.318] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:24:0) after 4m42s
[16:04:23.451] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:24:0)
[16:04:23.473] Build status: STARTED
[16:04:23.473] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:25:0) after 3m27s
[16:07:50.708] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:25:0)
[16:07:50.728] Build status: STARTED
[16:07:50.728] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:26:0) after 5m1s
[16:12:51.760] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:26:0)
[16:12:51.786] Build status: STARTED
[16:12:51.786] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:27:0) after 1m53s
[16:14:44.946] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:27:0)
[16:14:44.966] Build status: STARTED
[16:14:44.966] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:28:0) after 7m22s
[16:22:07.079] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:28:0)
[16:22:07.100] Build status: STARTED
[16:22:07.100] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:29:0) after 7m9s
[16:29:16.258] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:29:0)
[16:29:16.285] Build status: STARTED
[16:29:16.285] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:30:0) after 6m26s
[16:35:42.425] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:30:0)
[16:35:42.490] Build status: STARTED
[16:35:42.490] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:31:0) after 4m21s
[16:40:03.514] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:31:0)
[16:40:03.536] Build status: STARTED
[16:40:03.536] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:32:0) after 1m22s
[16:41:25.715] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:32:0)
[16:41:25.735] Build status: STARTED
[16:41:25.735] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:33:0) after 8m32s
[16:49:57.754] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:33:0)
[16:49:57.774] Build status: STARTED
[16:49:57.774] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:34:0) after 5m9s
[16:55:06.812] Handling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:34:0)
[16:55:06.834] Build status: STARTED
[16:55:06.834] Scheduling timer "check-buildbucket-build-status" (chromium/android-arm64-proguard-rel:8921631221118288448:35:0) after 4m23s
[16:57:55.892] Received PubSub notification, asking Buildbucket for the build status
[16:57:55.919] Build:
{
"id": "8756201159139046209",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "android-arm64-proguard-rel"
},
"number": 10000,
"createdBy": "project:chromium",
"createTime": "2024-02-13T14:01:07.450771361Z",
"startTime": "2024-02-13T14:01:58.590285Z",
"endTime": "2024-02-13T16:57:54.784616Z",
"updateTime": "2024-02-13T16:57:54.784616Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "a4279f28422a0b59acdc9fcfe7233d9f0e3b2dc6",
"ref": "refs/heads/main"
}
}
}
[16:57:55.919] Invocation finished in 2h56m49.740295935s with status FAILED