[21:41:48.265] New invocation is queued and will start shortly
[21:41:49.344] Starting the invocation (attempt 1)
[21:41:49.371] Popped buildset tag "buildset:commit/gitiles/qemu.googlesource.com/qemu/+/ab8008b231e758e03c87c1c483c03afdd9c02e19"
[21:41:49.371] Popped gitiles commit info from properties and tags
[21:41:49.371] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[21:41:49.371] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[21:41:49.372] Buildbucket request:
{
"requestId": "8868693607923355168",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "qemu-mac-arm64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8868693607923355168",
"job": "fuchsia/ci-qemu-mac-arm64-74eaa511",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "6657f3bb55edba8f068cbc9ac40bb230ea1d7a09"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@6657f3bb55edba8f068cbc9ac40bb230ea1d7a09",
"title": "6657f3bb55edba8f068cbc9ac40bb230ea1d7a09",
"url": "https://qemu.googlesource.com/qemu/+/6657f3bb55edba8f068cbc9ac40bb230ea1d7a09"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "c921e5496f23221335bea0c9104364409cd0b2b8"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@c921e5496f23221335bea0c9104364409cd0b2b8",
"title": "c921e5496f23221335bea0c9104364409cd0b2b8",
"url": "https://qemu.googlesource.com/qemu/+/c921e5496f23221335bea0c9104364409cd0b2b8"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "e5eacba4a3e6efdae8cda323f9a2ab5cfb1d0492"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@e5eacba4a3e6efdae8cda323f9a2ab5cfb1d0492",
"title": "e5eacba4a3e6efdae8cda323f9a2ab5cfb1d0492",
"url": "https://qemu.googlesource.com/qemu/+/e5eacba4a3e6efdae8cda323f9a2ab5cfb1d0492"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "7bc2cbe3306899559c4da1b05e410235d994e22d"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@7bc2cbe3306899559c4da1b05e410235d994e22d",
"title": "7bc2cbe3306899559c4da1b05e410235d994e22d",
"url": "https://qemu.googlesource.com/qemu/+/7bc2cbe3306899559c4da1b05e410235d994e22d"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "d343f395e371aa1b859eb42be331918931a6637e"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@d343f395e371aa1b859eb42be331918931a6637e",
"title": "d343f395e371aa1b859eb42be331918931a6637e",
"url": "https://qemu.googlesource.com/qemu/+/d343f395e371aa1b859eb42be331918931a6637e"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "6e9a6d57bf8de9e1edc207c24ed4e9e9508838c1"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@6e9a6d57bf8de9e1edc207c24ed4e9e9508838c1",
"title": "6e9a6d57bf8de9e1edc207c24ed4e9e9508838c1",
"url": "https://qemu.googlesource.com/qemu/+/6e9a6d57bf8de9e1edc207c24ed4e9e9508838c1"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "9adc8d052d1c6b3015ca07a6a0f0833fb725e06f"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@9adc8d052d1c6b3015ca07a6a0f0833fb725e06f",
"title": "9adc8d052d1c6b3015ca07a6a0f0833fb725e06f",
"url": "https://qemu.googlesource.com/qemu/+/9adc8d052d1c6b3015ca07a6a0f0833fb725e06f"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "4149afca711cc735a84ad61314bdcf41f69a7607"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@4149afca711cc735a84ad61314bdcf41f69a7607",
"title": "4149afca711cc735a84ad61314bdcf41f69a7607",
"url": "https://qemu.googlesource.com/qemu/+/4149afca711cc735a84ad61314bdcf41f69a7607"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "1ed8903916394fca2347c700da974ca3856274b2"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@1ed8903916394fca2347c700da974ca3856274b2",
"title": "1ed8903916394fca2347c700da974ca3856274b2",
"url": "https://qemu.googlesource.com/qemu/+/1ed8903916394fca2347c700da974ca3856274b2"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "fe6a74f365743ae3ce2cbbc4d44617d51a446a02"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@fe6a74f365743ae3ce2cbbc4d44617d51a446a02",
"title": "fe6a74f365743ae3ce2cbbc4d44617d51a446a02",
"url": "https://qemu.googlesource.com/qemu/+/fe6a74f365743ae3ce2cbbc4d44617d51a446a02"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "8cb17f9c36f3f92a4f653a0b369ec7ab82ccf5f0"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@8cb17f9c36f3f92a4f653a0b369ec7ab82ccf5f0",
"title": "8cb17f9c36f3f92a4f653a0b369ec7ab82ccf5f0",
"url": "https://qemu.googlesource.com/qemu/+/8cb17f9c36f3f92a4f653a0b369ec7ab82ccf5f0"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "09759245cf762d2fed4259494ec31198ac1ec0f4"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@09759245cf762d2fed4259494ec31198ac1ec0f4",
"title": "09759245cf762d2fed4259494ec31198ac1ec0f4",
"url": "https://qemu.googlesource.com/qemu/+/09759245cf762d2fed4259494ec31198ac1ec0f4"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "d14c8cc69dcd64031019da857f93ee5f6d64bb75"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@d14c8cc69dcd64031019da857f93ee5f6d64bb75",
"title": "d14c8cc69dcd64031019da857f93ee5f6d64bb75",
"url": "https://qemu.googlesource.com/qemu/+/d14c8cc69dcd64031019da857f93ee5f6d64bb75"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "5d1d32ce9d26a7cdc1c60dceb1b0c55ff9ad9b3e"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@5d1d32ce9d26a7cdc1c60dceb1b0c55ff9ad9b3e",
"title": "5d1d32ce9d26a7cdc1c60dceb1b0c55ff9ad9b3e",
"url": "https://qemu.googlesource.com/qemu/+/5d1d32ce9d26a7cdc1c60dceb1b0c55ff9ad9b3e"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "6f607941b1c01679d6d3dca036ddd23bbe95a44c"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@6f607941b1c01679d6d3dca036ddd23bbe95a44c",
"title": "6f607941b1c01679d6d3dca036ddd23bbe95a44c",
"url": "https://qemu.googlesource.com/qemu/+/6f607941b1c01679d6d3dca036ddd23bbe95a44c"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "69620c091d62f3a7016469c83b9064258524891d"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@69620c091d62f3a7016469c83b9064258524891d",
"title": "69620c091d62f3a7016469c83b9064258524891d",
"url": "https://qemu.googlesource.com/qemu/+/69620c091d62f3a7016469c83b9064258524891d"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "30b123acbb89bff8ce7e46f9eef8ad01c2f173c6"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@30b123acbb89bff8ce7e46f9eef8ad01c2f173c6",
"title": "30b123acbb89bff8ce7e46f9eef8ad01c2f173c6",
"url": "https://qemu.googlesource.com/qemu/+/30b123acbb89bff8ce7e46f9eef8ad01c2f173c6"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "34523df31962401871ff091a9d0993ac87a9848a"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@34523df31962401871ff091a9d0993ac87a9848a",
"title": "34523df31962401871ff091a9d0993ac87a9848a",
"url": "https://qemu.googlesource.com/qemu/+/34523df31962401871ff091a9d0993ac87a9848a"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "caf2e8de4ed056acad4fbdb6fe420d8124d38f11"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@caf2e8de4ed056acad4fbdb6fe420d8124d38f11",
"title": "caf2e8de4ed056acad4fbdb6fe420d8124d38f11",
"url": "https://qemu.googlesource.com/qemu/+/caf2e8de4ed056acad4fbdb6fe420d8124d38f11"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://qemu.googlesource.com/qemu",
"revision": "ab8008b231e758e03c87c1c483c03afdd9c02e19"
},
"id": "https://qemu.googlesource.com/qemu/+/refs/heads/master@ab8008b231e758e03c87c1c483c03afdd9c02e19",
"title": "ab8008b231e758e03c87c1c483c03afdd9c02e19",
"url": "https://qemu.googlesource.com/qemu/+/ab8008b231e758e03c87c1c483c03afdd9c02e19"
}
]
}
},
"gitilesCommit": {
"host": "qemu.googlesource.com",
"project": "qemu",
"id": "ab8008b231e758e03c87c1c483c03afdd9c02e19",
"ref": "refs/heads/master"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8868693607923355168"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/ci-qemu-mac-arm64-74eaa511"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[21:41:49.745] Scheduled build:
{
"id": "8703263546038683521",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "qemu-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-09-19T21:41:49.436955494Z",
"updateTime": "2025-09-19T21:41:49.436955494Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "qemu.googlesource.com",
"project": "qemu",
"id": "ab8008b231e758e03c87c1c483c03afdd9c02e19",
"ref": "refs/heads/master"
}
}
}
[21:41:49.745] Task URL: https://cr-buildbucket.appspot.com/build/8703263546038683521
[21:41:49.745] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:2:0) after 2m25s
[21:42:09.758] Received PubSub notification, asking Buildbucket for the build status
[21:42:09.848] Build status: SCHEDULED
[21:44:14.763] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:2:0)
[21:44:14.830] Build status: SCHEDULED
[21:44:14.830] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:4:0) after 8m58s
[21:53:12.853] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:4:0)
[21:53:12.913] Build status: SCHEDULED
[21:53:12.913] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:5:0) after 2m1s
[21:55:13.953] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:5:0)
[21:55:13.986] Build status: SCHEDULED
[21:55:13.987] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:6:0) after 7m25s
[22:02:39.035] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:6:0)
[22:02:39.057] Build status: SCHEDULED
[22:02:39.057] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:7:0) after 8m31s
[22:11:10.204] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:7:0)
[22:11:10.265] Build status: SCHEDULED
[22:11:10.265] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:8:0) after 8m28s
[22:19:38.281] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:8:0)
[22:19:38.302] Build status: SCHEDULED
[22:19:38.302] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:9:0) after 9m14s
[22:28:52.322] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:9:0)
[22:28:52.375] Build status: SCHEDULED
[22:28:52.375] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:10:0) after 3m15s
[22:32:07.394] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:10:0)
[22:32:07.419] Build status: SCHEDULED
[22:32:07.419] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:11:0) after 5m16s
[22:37:23.532] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:11:0)
[22:37:23.552] Build status: SCHEDULED
[22:37:23.552] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:12:0) after 6m59s
[22:44:22.571] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:12:0)
[22:44:22.600] Build status: SCHEDULED
[22:44:22.600] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:13:0) after 3m46s
[22:48:08.659] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:13:0)
[22:48:08.684] Build status: SCHEDULED
[22:48:08.684] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:14:0) after 3m6s
[22:51:14.750] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:14:0)
[22:51:14.766] Build status: SCHEDULED
[22:51:14.766] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:15:0) after 9m10s
[23:00:24.783] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:15:0)
[23:00:24.802] Build status: SCHEDULED
[23:00:24.802] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:16:0) after 9m40s
[23:10:04.924] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:16:0)
[23:10:04.949] Build status: SCHEDULED
[23:10:04.949] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:17:0) after 3m37s
[23:13:41.969] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:17:0)
[23:13:41.996] Build status: SCHEDULED
[23:13:41.996] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:18:0) after 4m48s
[23:18:30.015] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:18:0)
[23:18:30.031] Build status: SCHEDULED
[23:18:30.031] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:19:0) after 3m34s
[23:20:39.705] Received PubSub notification, asking Buildbucket for the build status
[23:20:39.766] Build status: STARTED
[23:22:04.050] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:19:0)
[23:22:04.071] Build status: STARTED
[23:22:04.071] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:21:0) after 3m45s
[23:25:49.134] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:21:0)
[23:25:49.148] Build status: STARTED
[23:25:49.148] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:22:0) after 4m28s
[23:30:17.189] Handling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:22:0)
[23:30:17.206] Build status: STARTED
[23:30:17.206] Scheduling timer "check-buildbucket-build-status" (fuchsia/ci-qemu-mac-arm64-74eaa511:8868693607923355168:23:0) after 7m13s
[23:32:28.288] Received PubSub notification, asking Buildbucket for the build status
[23:32:28.311] Build:
{
"id": "8703263546038683521",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "qemu-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-09-19T21:41:49.436955494Z",
"startTime": "2025-09-19T23:20:39.461152831Z",
"endTime": "2025-09-19T23:32:27.934220527Z",
"updateTime": "2025-09-19T23:32:27.934220527Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "qemu.googlesource.com",
"project": "qemu",
"id": "ab8008b231e758e03c87c1c483c03afdd9c02e19",
"ref": "refs/heads/master"
}
}
}
[23:32:28.311] Invocation finished in 1h50m40.055911964s with status SUCCEEDED