[01:55:38.441] New invocation is queued and will start shortly
[01:55:39.471] Starting the invocation (attempt 1)
[01:55:39.501] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/980b30605bc4b9c948c12026a4dfc5ccf8ef5d25"
[01:55:39.501] Popped gitiles commit info from properties and tags
[01:55:39.501] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[01:55:39.502] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[01:55:39.502] Buildbucket request:
{
"requestId": "8847477947781625360",
"builder": {
"project": "chromium-m149",
"bucket": "ci",
"builder": "android-desktop-x64-official"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8847477947781625360",
"job": "chromium-m149/android-desktop-x64-official",
"triggers": [
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "24096268b4b01d30123696d52c3ba5429ac8190d"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@24096268b4b01d30123696d52c3ba5429ac8190d",
"title": "24096268b4b01d30123696d52c3ba5429ac8190d",
"url": "https://chromium.googlesource.com/chromium/src/+/24096268b4b01d30123696d52c3ba5429ac8190d"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "3e59d376346b4c7d7cae4c403f5771d5ad32a62d"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@3e59d376346b4c7d7cae4c403f5771d5ad32a62d",
"title": "3e59d376346b4c7d7cae4c403f5771d5ad32a62d",
"url": "https://chromium.googlesource.com/chromium/src/+/3e59d376346b4c7d7cae4c403f5771d5ad32a62d"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "981220c38f316e9072001a246d59c495c1fe3cb2"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@981220c38f316e9072001a246d59c495c1fe3cb2",
"title": "981220c38f316e9072001a246d59c495c1fe3cb2",
"url": "https://chromium.googlesource.com/chromium/src/+/981220c38f316e9072001a246d59c495c1fe3cb2"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "8046eac9c5ce994192e3a89c81bca6f651f99557"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@8046eac9c5ce994192e3a89c81bca6f651f99557",
"title": "8046eac9c5ce994192e3a89c81bca6f651f99557",
"url": "https://chromium.googlesource.com/chromium/src/+/8046eac9c5ce994192e3a89c81bca6f651f99557"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "dd1883a37440fcd75e9ce77aeb7a8a2ee4057e79"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@dd1883a37440fcd75e9ce77aeb7a8a2ee4057e79",
"title": "dd1883a37440fcd75e9ce77aeb7a8a2ee4057e79",
"url": "https://chromium.googlesource.com/chromium/src/+/dd1883a37440fcd75e9ce77aeb7a8a2ee4057e79"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "0c0136f01fa12d6f7128dd7aa3b40f3232ae9fde"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@0c0136f01fa12d6f7128dd7aa3b40f3232ae9fde",
"title": "0c0136f01fa12d6f7128dd7aa3b40f3232ae9fde",
"url": "https://chromium.googlesource.com/chromium/src/+/0c0136f01fa12d6f7128dd7aa3b40f3232ae9fde"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "386d89876b7c2088c3718d378295cf4c99a5f273"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@386d89876b7c2088c3718d378295cf4c99a5f273",
"title": "386d89876b7c2088c3718d378295cf4c99a5f273",
"url": "https://chromium.googlesource.com/chromium/src/+/386d89876b7c2088c3718d378295cf4c99a5f273"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "fe728380ce73c7c40198e4711e6c201393bb483d"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@fe728380ce73c7c40198e4711e6c201393bb483d",
"title": "fe728380ce73c7c40198e4711e6c201393bb483d",
"url": "https://chromium.googlesource.com/chromium/src/+/fe728380ce73c7c40198e4711e6c201393bb483d"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "931b8f6f13e89e5274cc3dac7d9bda1f21db32cf"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@931b8f6f13e89e5274cc3dac7d9bda1f21db32cf",
"title": "931b8f6f13e89e5274cc3dac7d9bda1f21db32cf",
"url": "https://chromium.googlesource.com/chromium/src/+/931b8f6f13e89e5274cc3dac7d9bda1f21db32cf"
},
{
"gitiles": {
"ref": "refs/branch-heads/7827",
"repo": "https://chromium.googlesource.com/chromium/src",
"revision": "980b30605bc4b9c948c12026a4dfc5ccf8ef5d25"
},
"id": "https://chromium.googlesource.com/chromium/src/+/refs/branch-heads/7827@980b30605bc4b9c948c12026a4dfc5ccf8ef5d25",
"title": "980b30605bc4b9c948c12026a4dfc5ccf8ef5d25",
"url": "https://chromium.googlesource.com/chromium/src/+/980b30605bc4b9c948c12026a4dfc5ccf8ef5d25"
}
]
}
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "980b30605bc4b9c948c12026a4dfc5ccf8ef5d25",
"ref": "refs/branch-heads/7827"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8847477947781625360"
},
{
"key": "scheduler_job_id",
"value": "chromium-m149/android-desktop-x64-official"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[01:55:40.077] Scheduled build:
{
"id": "8682047885893333361",
"builder": {
"project": "chromium-m149",
"bucket": "ci",
"builder": "android-desktop-x64-official"
},
"number": 46,
"createdBy": "project:chromium-m149",
"createTime": "2026-05-12T01:55:39.622202829Z",
"updateTime": "2026-05-12T01:55:39.622202829Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "980b30605bc4b9c948c12026a4dfc5ccf8ef5d25",
"ref": "refs/branch-heads/7827"
}
}
}
[01:55:40.077] Task URL: https://cr-buildbucket.appspot.com/build/8682047885893333361
[01:55:40.077] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:2:0) after 3m20s
[01:55:43.349] Received PubSub notification, asking Buildbucket for the build status
[01:55:43.367] Build status: SCHEDULED
[01:59:00.144] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:2:0)
[01:59:00.170] Build status: SCHEDULED
[01:59:00.170] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:4:0) after 4m38s
[02:03:38.143] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:4:0)
[02:03:38.188] Build status: SCHEDULED
[02:03:38.188] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:5:0) after 3m4s
[02:06:42.167] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:5:0)
[02:06:42.190] Build status: SCHEDULED
[02:06:42.190] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:6:0) after 2m35s
[02:09:17.205] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:6:0)
[02:09:17.224] Build status: SCHEDULED
[02:09:17.224] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:7:0) after 7m39s
[02:16:56.240] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:7:0)
[02:16:56.272] Build status: SCHEDULED
[02:16:56.272] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:8:0) after 4m34s
[02:21:30.281] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:8:0)
[02:21:30.350] Build status: SCHEDULED
[02:21:30.350] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:9:0) after 1m25s
[02:22:55.326] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:9:0)
[02:22:55.342] Build status: SCHEDULED
[02:22:55.342] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:10:0) after 3m24s
[02:26:19.412] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:10:0)
[02:26:19.440] Build status: SCHEDULED
[02:26:19.440] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:11:0) after 8m55s
[02:35:14.504] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:11:0)
[02:35:14.522] Build status: SCHEDULED
[02:35:14.522] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:12:0) after 2m43s
[02:37:57.537] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:12:0)
[02:37:57.555] Build status: SCHEDULED
[02:37:57.555] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:13:0) after 8m50s
[02:46:47.577] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:13:0)
[02:46:47.593] Build status: SCHEDULED
[02:46:47.593] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:14:0) after 7m48s
[02:48:20.500] Received PubSub notification, asking Buildbucket for the build status
[02:48:20.520] Build status: STARTED
[02:54:35.606] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:14:0)
[02:54:35.626] Build status: STARTED
[02:54:35.626] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:16:0) after 8m21s
[03:02:56.735] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:16:0)
[03:02:56.780] Build status: STARTED
[03:02:56.780] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:17:0) after 6m48s
[03:09:44.816] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:17:0)
[03:09:44.944] Build status: STARTED
[03:09:44.965] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:18:0) after 5m22s
[03:15:06.987] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:18:0)
[03:15:07.019] Build status: STARTED
[03:15:07.019] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:19:0) after 6m0s
[03:21:07.055] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:19:0)
[03:21:07.073] Build status: STARTED
[03:21:07.073] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:20:0) after 1m29s
[03:22:36.104] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:20:0)
[03:22:36.132] Build status: STARTED
[03:22:36.132] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:21:0) after 7m37s
[03:30:13.154] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:21:0)
[03:30:13.181] Build status: STARTED
[03:30:13.181] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:22:0) after 9m33s
[03:39:46.198] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:22:0)
[03:39:46.222] Build status: STARTED
[03:39:46.222] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:23:0) after 2m12s
[03:41:58.238] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:23:0)
[03:41:58.265] Build status: STARTED
[03:41:58.265] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:24:0) after 2m24s
[03:44:22.278] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:24:0)
[03:44:22.309] Build status: STARTED
[03:44:22.309] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:25:0) after 5m57s
[03:50:19.376] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:25:0)
[03:50:19.392] Build status: STARTED
[03:50:19.392] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:26:0) after 4m45s
[03:55:04.465] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:26:0)
[03:55:04.489] Build status: STARTED
[03:55:04.489] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:27:0) after 4m19s
[03:59:23.504] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:27:0)
[03:59:23.519] Build status: STARTED
[03:59:23.519] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:28:0) after 2m18s
[04:01:41.532] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:28:0)
[04:01:41.607] Build status: STARTED
[04:01:41.607] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:29:0) after 7m51s
[04:09:32.623] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:29:0)
[04:09:32.643] Build status: STARTED
[04:09:32.643] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:30:0) after 8m46s
[04:18:18.661] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:30:0)
[04:18:18.701] Build status: STARTED
[04:18:18.701] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:31:0) after 6m56s
[04:25:14.757] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:31:0)
[04:25:14.777] Build status: STARTED
[04:25:14.777] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:32:0) after 3m4s
[04:28:18.792] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:32:0)
[04:28:18.809] Build status: STARTED
[04:28:18.809] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:33:0) after 8m47s
[04:37:05.888] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:33:0)
[04:37:05.908] Build status: STARTED
[04:37:05.909] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:34:0) after 3m35s
[04:40:40.974] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:34:0)
[04:40:40.991] Build status: STARTED
[04:40:40.991] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:35:0) after 4m58s
[04:45:39.007] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:35:0)
[04:45:39.040] Build status: STARTED
[04:45:39.040] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:36:0) after 3m45s
[04:49:24.256] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:36:0)
[04:49:24.274] Build status: STARTED
[04:49:24.274] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:37:0) after 8m14s
[04:57:38.291] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:37:0)
[04:57:38.310] Build status: STARTED
[04:57:38.311] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:38:0) after 8m57s
[05:06:35.325] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:38:0)
[05:06:35.424] Build status: STARTED
[05:06:35.424] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:39:0) after 7m38s
[05:14:13.439] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:39:0)
[05:14:13.468] Build status: STARTED
[05:14:13.468] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:40:0) after 7m23s
[05:21:36.484] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:40:0)
[05:21:36.501] Build status: STARTED
[05:21:36.501] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:41:0) after 9m38s
[05:31:14.531] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:41:0)
[05:31:14.555] Build status: STARTED
[05:31:14.555] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:42:0) after 9m24s
[05:40:38.619] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:42:0)
[05:40:38.648] Build status: STARTED
[05:40:38.648] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:43:0) after 3m7s
[05:43:45.667] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:43:0)
[05:43:45.760] Build status: STARTED
[05:43:45.760] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:44:0) after 3m53s
[05:47:38.778] Handling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:44:0)
[05:47:38.797] Build status: STARTED
[05:47:38.797] Scheduling timer "check-buildbucket-build-status" (chromium-m149/android-desktop-x64-official:8847477947781625360:45:0) after 6m54s
[05:50:34.593] Received PubSub notification, asking Buildbucket for the build status
[05:50:34.618] Build:
{
"id": "8682047885893333361",
"builder": {
"project": "chromium-m149",
"bucket": "ci",
"builder": "android-desktop-x64-official"
},
"number": 46,
"createdBy": "project:chromium-m149",
"createTime": "2026-05-12T01:55:39.622202829Z",
"startTime": "2026-05-12T02:48:20.262772683Z",
"endTime": "2026-05-12T05:50:34.203919938Z",
"updateTime": "2026-05-12T05:50:34.203919938Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "980b30605bc4b9c948c12026a4dfc5ccf8ef5d25",
"ref": "refs/branch-heads/7827"
}
}
}
[05:50:34.618] Invocation finished in 3h54m56.180503542s with status SUCCEEDED