[00:20:48.064] New invocation is queued and will start shortly
[00:20:49.126] Starting the invocation (attempt 1)
[00:20:49.149] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf"
[00:20:49.149] Popped gitiles commit info from properties and tags
[00:20:49.149] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[00:20:49.149] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[00:20:49.150] Buildbucket request:
{
"requestId": "8864606741229183728",
"builder": {
"project": "chromium-m143",
"bucket": "ci",
"builder": "chromeos-octopus-rel"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8864606741229183728",
"job": "chromium-m143/chromeos-octopus-rel",
"triggers": [
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "68b1162b0ec3243b29fc47fb2af71a707d48eef2"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@68b1162b0ec3243b29fc47fb2af71a707d48eef2",
"title": "68b1162b0ec3243b29fc47fb2af71a707d48eef2",
"url": "https://chromium.googlesource.com/chromium/src/+/68b1162b0ec3243b29fc47fb2af71a707d48eef2"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "5c3a56133f91b199f67273c2cdab3847ae619e7d"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@5c3a56133f91b199f67273c2cdab3847ae619e7d",
"title": "5c3a56133f91b199f67273c2cdab3847ae619e7d",
"url": "https://chromium.googlesource.com/chromium/src/+/5c3a56133f91b199f67273c2cdab3847ae619e7d"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "0ef1626484db42a183a888c28f4016eabf069c40"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@0ef1626484db42a183a888c28f4016eabf069c40",
"title": "0ef1626484db42a183a888c28f4016eabf069c40",
"url": "https://chromium.googlesource.com/chromium/src/+/0ef1626484db42a183a888c28f4016eabf069c40"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "43e21fcae6322245e68225411d7be4db75518c97"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@43e21fcae6322245e68225411d7be4db75518c97",
"title": "43e21fcae6322245e68225411d7be4db75518c97",
"url": "https://chromium.googlesource.com/chromium/src/+/43e21fcae6322245e68225411d7be4db75518c97"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "1fb02b4341d9e9229e9370a16e88bf86f0766d76"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@1fb02b4341d9e9229e9370a16e88bf86f0766d76",
"title": "1fb02b4341d9e9229e9370a16e88bf86f0766d76",
"url": "https://chromium.googlesource.com/chromium/src/+/1fb02b4341d9e9229e9370a16e88bf86f0766d76"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "e02c80edfa6a614167cb526c7dee41c41fc46d75"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@e02c80edfa6a614167cb526c7dee41c41fc46d75",
"title": "e02c80edfa6a614167cb526c7dee41c41fc46d75",
"url": "https://chromium.googlesource.com/chromium/src/+/e02c80edfa6a614167cb526c7dee41c41fc46d75"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "6ca87c1a778cf38d668bd29dbb90f0bfb8128234"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@6ca87c1a778cf38d668bd29dbb90f0bfb8128234",
"title": "6ca87c1a778cf38d668bd29dbb90f0bfb8128234",
"url": "https://chromium.googlesource.com/chromium/src/+/6ca87c1a778cf38d668bd29dbb90f0bfb8128234"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "6be5066e5447dc64b7a0bb1375920582b6b9d5c7"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@6be5066e5447dc64b7a0bb1375920582b6b9d5c7",
"title": "6be5066e5447dc64b7a0bb1375920582b6b9d5c7",
"url": "https://chromium.googlesource.com/chromium/src/+/6be5066e5447dc64b7a0bb1375920582b6b9d5c7"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "9623095be9b1d46021f78c2ab88894fd507f381a"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@9623095be9b1d46021f78c2ab88894fd507f381a",
"title": "9623095be9b1d46021f78c2ab88894fd507f381a",
"url": "https://chromium.googlesource.com/chromium/src/+/9623095be9b1d46021f78c2ab88894fd507f381a"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "a19bcc274992ef0070956e6dfc90dafd4fda7934"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@a19bcc274992ef0070956e6dfc90dafd4fda7934",
"title": "a19bcc274992ef0070956e6dfc90dafd4fda7934",
"url": "https://chromium.googlesource.com/chromium/src/+/a19bcc274992ef0070956e6dfc90dafd4fda7934"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "859f0e3fb303189e0bfcade8c1c13c0668604a08"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@859f0e3fb303189e0bfcade8c1c13c0668604a08",
"title": "859f0e3fb303189e0bfcade8c1c13c0668604a08",
"url": "https://chromium.googlesource.com/chromium/src/+/859f0e3fb303189e0bfcade8c1c13c0668604a08"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "14d22273922395470ad1bb8274dc100077a7fb0a"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@14d22273922395470ad1bb8274dc100077a7fb0a",
"title": "14d22273922395470ad1bb8274dc100077a7fb0a",
"url": "https://chromium.googlesource.com/chromium/src/+/14d22273922395470ad1bb8274dc100077a7fb0a"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "648f5fa02b388f0d6d6f87efbbb3bfe79304d4b4"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@648f5fa02b388f0d6d6f87efbbb3bfe79304d4b4",
"title": "648f5fa02b388f0d6d6f87efbbb3bfe79304d4b4",
"url": "https://chromium.googlesource.com/chromium/src/+/648f5fa02b388f0d6d6f87efbbb3bfe79304d4b4"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "93e1774f721912824c8bfb7042b8d840a3114433"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@93e1774f721912824c8bfb7042b8d840a3114433",
"title": "93e1774f721912824c8bfb7042b8d840a3114433",
"url": "https://chromium.googlesource.com/chromium/src/+/93e1774f721912824c8bfb7042b8d840a3114433"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "a81ffebc42f0109e7a05fbafdb39fca29b7da5be"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@a81ffebc42f0109e7a05fbafdb39fca29b7da5be",
"title": "a81ffebc42f0109e7a05fbafdb39fca29b7da5be",
"url": "https://chromium.googlesource.com/chromium/src/+/a81ffebc42f0109e7a05fbafdb39fca29b7da5be"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "df7eb5e2df806f21e3f8a7f29ef4351f0cd241aa"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@df7eb5e2df806f21e3f8a7f29ef4351f0cd241aa",
"title": "df7eb5e2df806f21e3f8a7f29ef4351f0cd241aa",
"url": "https://chromium.googlesource.com/chromium/src/+/df7eb5e2df806f21e3f8a7f29ef4351f0cd241aa"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "554f80f0f07bd15d139bec0fdcfe4c887d33233d"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@554f80f0f07bd15d139bec0fdcfe4c887d33233d",
"title": "554f80f0f07bd15d139bec0fdcfe4c887d33233d",
"url": "https://chromium.googlesource.com/chromium/src/+/554f80f0f07bd15d139bec0fdcfe4c887d33233d"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "8ac82a80cac11ce5b3f749dde815057e35b44c6f"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@8ac82a80cac11ce5b3f749dde815057e35b44c6f",
"title": "8ac82a80cac11ce5b3f749dde815057e35b44c6f",
"url": "https://chromium.googlesource.com/chromium/src/+/8ac82a80cac11ce5b3f749dde815057e35b44c6f"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "fa554b86b0be1eba2bb4bcddcc4c80c0078a912e"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@fa554b86b0be1eba2bb4bcddcc4c80c0078a912e",
"title": "fa554b86b0be1eba2bb4bcddcc4c80c0078a912e",
"url": "https://chromium.googlesource.com/chromium/src/+/fa554b86b0be1eba2bb4bcddcc4c80c0078a912e"
},
{
"gitiles": {
"ref": "refs/branch-heads/7499",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7499@ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf",
"title": "ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf",
"url": "https://chromium.googlesource.com/chromium/src/+/ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf"
}
]
}
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf",
"ref": "refs/branch-heads/7499"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8864606741229183728"
},
{
"key": "scheduler_job_id",
"value": "chromium-m143/chromeos-octopus-rel"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[00:20:49.848] Scheduled build:
{
"id": "8699176679366848657",
"builder": {
"project": "chromium-m143",
"bucket": "ci",
"builder": "chromeos-octopus-rel"
},
"number": 96,
"createdBy": "project:chromium-m143",
"createTime": "2025-11-04T00:20:49.215554024Z",
"updateTime": "2025-11-04T00:20:49.215554024Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf",
"ref": "refs/branch-heads/7499"
}
}
}
[00:20:49.848] Task URL: https://cr-buildbucket.appspot.com/build/8699176679366848657
[00:20:49.848] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:2:0) after 8m55s
[00:20:50.684] Received PubSub notification, asking Buildbucket for the build status
[00:20:50.711] Build status: SCHEDULED
[00:21:29.653] Received PubSub notification, asking Buildbucket for the build status
[00:21:29.668] Build status: STARTED
[00:29:44.827] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:2:0)
[00:29:44.841] Build status: STARTED
[00:29:44.841] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:5:0) after 8m51s
[00:38:35.906] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:5:0)
[00:38:35.933] Build status: STARTED
[00:38:35.933] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:6:0) after 3m4s
[00:41:39.963] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:6:0)
[00:41:39.990] Build status: STARTED
[00:41:39.990] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:7:0) after 6m12s
[00:47:52.010] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:7:0)
[00:47:52.029] Build status: STARTED
[00:47:52.029] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:8:0) after 6m2s
[00:53:54.266] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:8:0)
[00:53:54.307] Build status: STARTED
[00:53:54.307] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:9:0) after 1m11s
[00:55:05.354] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:9:0)
[00:55:05.376] Build status: STARTED
[00:55:05.376] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:10:0) after 2m27s
[00:57:32.390] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:10:0)
[00:57:32.406] Build status: STARTED
[00:57:32.406] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:11:0) after 4m52s
[01:02:24.395] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:11:0)
[01:02:24.412] Build status: STARTED
[01:02:24.412] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:12:0) after 1m49s
[01:04:13.447] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:12:0)
[01:04:13.540] Build status: STARTED
[01:04:13.540] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:13:0) after 8m0s
[01:12:13.559] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:13:0)
[01:12:13.578] Build status: STARTED
[01:12:13.578] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:14:0) after 1m19s
[01:13:32.674] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:14:0)
[01:13:32.715] Build status: STARTED
[01:13:32.715] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:15:0) after 6m22s
[01:19:54.835] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:15:0)
[01:19:54.853] Build status: STARTED
[01:19:54.853] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:16:0) after 3m56s
[01:23:50.871] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:16:0)
[01:23:50.887] Build status: STARTED
[01:23:50.887] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:17:0) after 2m32s
[01:26:22.941] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:17:0)
[01:26:22.957] Build status: STARTED
[01:26:22.957] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:18:0) after 6m28s
[01:32:51.155] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:18:0)
[01:32:51.215] Build status: STARTED
[01:32:51.215] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:19:0) after 5m17s
[01:38:08.254] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:19:0)
[01:38:08.270] Build status: STARTED
[01:38:08.271] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:20:0) after 7m25s
[01:45:33.359] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:20:0)
[01:45:33.488] Build status: STARTED
[01:45:33.488] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:21:0) after 5m40s
[01:51:13.867] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:21:0)
[01:51:13.935] Build status: STARTED
[01:51:13.935] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:22:0) after 4m58s
[01:56:12.028] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:22:0)
[01:56:12.087] Build status: STARTED
[01:56:12.087] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:23:0) after 6m59s
[02:03:11.141] Handling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:23:0)
[02:03:11.158] Build status: STARTED
[02:03:11.158] Scheduling timer "check-buildbucket-build-status" (chromium-m143/chromeos-octopus-rel:8864606741229183728:24:0) after 9m7s
[02:03:37.012] Received PubSub notification, asking Buildbucket for the build status
[02:03:37.031] Build:
{
"id": "8699176679366848657",
"builder": {
"project": "chromium-m143",
"bucket": "ci",
"builder": "chromeos-octopus-rel"
},
"number": 96,
"createdBy": "project:chromium-m143",
"createTime": "2025-11-04T00:20:49.215554024Z",
"startTime": "2025-11-04T00:21:29.427934108Z",
"endTime": "2025-11-04T02:03:36.121753387Z",
"updateTime": "2025-11-04T02:03:36.121753387Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "ef1f059c1ac1aaa2e65664e5baf95e01cf9eb3bf",
"ref": "refs/branch-heads/7499"
}
}
}
[02:03:37.031] Invocation finished in 1h42m48.975120291s with status FAILED