[20:05:49.545] New invocation is queued and will start shortly
[20:05:50.872] Starting the invocation (attempt 1)
[20:05:50.898] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/f93b8b468c436ceb2e7589cc91b31b418ca90bb1"
[20:05:50.898] Popped gitiles commit info from properties and tags
[20:05:50.898] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:05:50.898] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:05:50.898] Buildbucket request:
{
"requestId": "8930396180495955808",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.arm64-asan"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8930396180495955808",
"job": "fuchsia/core.arm64-asan-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "40db271b1e280e5a79f3ace35cc713bf52f1a934"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@40db271b1e280e5a79f3ace35cc713bf52f1a934",
"title": "40db271b1e280e5a79f3ace35cc713bf52f1a934",
"url": "https://fuchsia.googlesource.com/integration/+/40db271b1e280e5a79f3ace35cc713bf52f1a934"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "b3b400e75a602033668194bda819c2c6da08f186"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@b3b400e75a602033668194bda819c2c6da08f186",
"title": "b3b400e75a602033668194bda819c2c6da08f186",
"url": "https://fuchsia.googlesource.com/integration/+/b3b400e75a602033668194bda819c2c6da08f186"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8d4abe78881e5ad1ccd304c755124ef166fb2b83"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8d4abe78881e5ad1ccd304c755124ef166fb2b83",
"title": "8d4abe78881e5ad1ccd304c755124ef166fb2b83",
"url": "https://fuchsia.googlesource.com/integration/+/8d4abe78881e5ad1ccd304c755124ef166fb2b83"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "e6db91b2826aa7499dd563606e1a5db67c57df15"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@e6db91b2826aa7499dd563606e1a5db67c57df15",
"title": "e6db91b2826aa7499dd563606e1a5db67c57df15",
"url": "https://fuchsia.googlesource.com/integration/+/e6db91b2826aa7499dd563606e1a5db67c57df15"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "a68014c8a99dea989b5e3227a442634514bace4b"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@a68014c8a99dea989b5e3227a442634514bace4b",
"title": "a68014c8a99dea989b5e3227a442634514bace4b",
"url": "https://fuchsia.googlesource.com/integration/+/a68014c8a99dea989b5e3227a442634514bace4b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "342f289435fed298f7900951ece08a03d62af30e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@342f289435fed298f7900951ece08a03d62af30e",
"title": "342f289435fed298f7900951ece08a03d62af30e",
"url": "https://fuchsia.googlesource.com/integration/+/342f289435fed298f7900951ece08a03d62af30e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "16a4f3d3267b1cd89de4f9e0708f29e52c53858d"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@16a4f3d3267b1cd89de4f9e0708f29e52c53858d",
"title": "16a4f3d3267b1cd89de4f9e0708f29e52c53858d",
"url": "https://fuchsia.googlesource.com/integration/+/16a4f3d3267b1cd89de4f9e0708f29e52c53858d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "d1befca22af62a1bde2d2f3c13ea3fc73f66ac8a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@d1befca22af62a1bde2d2f3c13ea3fc73f66ac8a",
"title": "d1befca22af62a1bde2d2f3c13ea3fc73f66ac8a",
"url": "https://fuchsia.googlesource.com/integration/+/d1befca22af62a1bde2d2f3c13ea3fc73f66ac8a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "1cfb4184586afb21adc2db8f06ecbf7242bc121a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@1cfb4184586afb21adc2db8f06ecbf7242bc121a",
"title": "1cfb4184586afb21adc2db8f06ecbf7242bc121a",
"url": "https://fuchsia.googlesource.com/integration/+/1cfb4184586afb21adc2db8f06ecbf7242bc121a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "ddbd545b26ac36d22da50a6910a4cd41f44c75fa"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@ddbd545b26ac36d22da50a6910a4cd41f44c75fa",
"title": "ddbd545b26ac36d22da50a6910a4cd41f44c75fa",
"url": "https://fuchsia.googlesource.com/integration/+/ddbd545b26ac36d22da50a6910a4cd41f44c75fa"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "fb6a0dbb5e0884a4657795bc85f3bfc2761b8147"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@fb6a0dbb5e0884a4657795bc85f3bfc2761b8147",
"title": "fb6a0dbb5e0884a4657795bc85f3bfc2761b8147",
"url": "https://fuchsia.googlesource.com/integration/+/fb6a0dbb5e0884a4657795bc85f3bfc2761b8147"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "0e52bd46461f2318323e336af0c0286a408ff271"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@0e52bd46461f2318323e336af0c0286a408ff271",
"title": "0e52bd46461f2318323e336af0c0286a408ff271",
"url": "https://fuchsia.googlesource.com/integration/+/0e52bd46461f2318323e336af0c0286a408ff271"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5baf6d3adc0b089e6ab4ae3f081e743e800ad858"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5baf6d3adc0b089e6ab4ae3f081e743e800ad858",
"title": "5baf6d3adc0b089e6ab4ae3f081e743e800ad858",
"url": "https://fuchsia.googlesource.com/integration/+/5baf6d3adc0b089e6ab4ae3f081e743e800ad858"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "3bca588ee65d67a5d08b93f15b2d0df46360cb6d"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@3bca588ee65d67a5d08b93f15b2d0df46360cb6d",
"title": "3bca588ee65d67a5d08b93f15b2d0df46360cb6d",
"url": "https://fuchsia.googlesource.com/integration/+/3bca588ee65d67a5d08b93f15b2d0df46360cb6d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "dc81fd455d4c19de5aa60785bc61a7fef0a421ce"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@dc81fd455d4c19de5aa60785bc61a7fef0a421ce",
"title": "dc81fd455d4c19de5aa60785bc61a7fef0a421ce",
"url": "https://fuchsia.googlesource.com/integration/+/dc81fd455d4c19de5aa60785bc61a7fef0a421ce"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f75af1036a855f74724eca5fdc11fef9ed8616e7"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f75af1036a855f74724eca5fdc11fef9ed8616e7",
"title": "f75af1036a855f74724eca5fdc11fef9ed8616e7",
"url": "https://fuchsia.googlesource.com/integration/+/f75af1036a855f74724eca5fdc11fef9ed8616e7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "bf93e50bd81fba0072091e5c267609b5548fe68e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@bf93e50bd81fba0072091e5c267609b5548fe68e",
"title": "bf93e50bd81fba0072091e5c267609b5548fe68e",
"url": "https://fuchsia.googlesource.com/integration/+/bf93e50bd81fba0072091e5c267609b5548fe68e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5e24d2cfb26d43da74aa885204692958da68f575"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5e24d2cfb26d43da74aa885204692958da68f575",
"title": "5e24d2cfb26d43da74aa885204692958da68f575",
"url": "https://fuchsia.googlesource.com/integration/+/5e24d2cfb26d43da74aa885204692958da68f575"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "9b06a9f07fac055f43e10de7d16ccfca3a8e3fa4"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@9b06a9f07fac055f43e10de7d16ccfca3a8e3fa4",
"title": "9b06a9f07fac055f43e10de7d16ccfca3a8e3fa4",
"url": "https://fuchsia.googlesource.com/integration/+/9b06a9f07fac055f43e10de7d16ccfca3a8e3fa4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8d64a60d442b781af3c680bf054095591befa8bb"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8d64a60d442b781af3c680bf054095591befa8bb",
"title": "8d64a60d442b781af3c680bf054095591befa8bb",
"url": "https://fuchsia.googlesource.com/integration/+/8d64a60d442b781af3c680bf054095591befa8bb"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "e1d05ef320154c5dc6157788ed36441858bce204"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@e1d05ef320154c5dc6157788ed36441858bce204",
"title": "e1d05ef320154c5dc6157788ed36441858bce204",
"url": "https://fuchsia.googlesource.com/integration/+/e1d05ef320154c5dc6157788ed36441858bce204"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "0681977122a06b2bfa25e2ff71dd3fddd5d84663"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@0681977122a06b2bfa25e2ff71dd3fddd5d84663",
"title": "0681977122a06b2bfa25e2ff71dd3fddd5d84663",
"url": "https://fuchsia.googlesource.com/integration/+/0681977122a06b2bfa25e2ff71dd3fddd5d84663"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "70e7bf7590757f5c163b304aecb9ec1436ca0375"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@70e7bf7590757f5c163b304aecb9ec1436ca0375",
"title": "70e7bf7590757f5c163b304aecb9ec1436ca0375",
"url": "https://fuchsia.googlesource.com/integration/+/70e7bf7590757f5c163b304aecb9ec1436ca0375"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f93b8b468c436ceb2e7589cc91b31b418ca90bb1"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f93b8b468c436ceb2e7589cc91b31b418ca90bb1",
"title": "f93b8b468c436ceb2e7589cc91b31b418ca90bb1",
"url": "https://fuchsia.googlesource.com/integration/+/f93b8b468c436ceb2e7589cc91b31b418ca90bb1"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "f93b8b468c436ceb2e7589cc91b31b418ca90bb1",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8930396180495955808"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/core.arm64-asan-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[20:05:51.860] Scheduled build:
{
"id": "8764966118351051681",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.arm64-asan"
},
"createdBy": "project:fuchsia",
"createTime": "2023-11-08T20:05:50.965627052Z",
"updateTime": "2023-11-08T20:05:50.965627052Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "f93b8b468c436ceb2e7589cc91b31b418ca90bb1",
"ref": "refs/heads/main"
}
}
}
[20:05:51.860] Task URL: https://cr-buildbucket.appspot.com/build/8764966118351051681
[20:05:51.860] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:2:0) after 4m54s
[20:05:52.540] Received PubSub notification, asking Buildbucket for the build status
[20:05:52.573] Build status: SCHEDULED
[20:06:32.742] Received PubSub notification, asking Buildbucket for the build status
[20:06:32.776] Build status: STARTED
[20:10:45.958] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:2:0)
[20:10:45.999] Build status: STARTED
[20:10:45.999] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:5:0) after 4m22s
[20:15:08.021] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:5:0)
[20:15:08.047] Build status: STARTED
[20:15:08.048] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:6:0) after 9m2s
[20:24:10.187] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:6:0)
[20:24:10.216] Build status: STARTED
[20:24:10.216] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:7:0) after 2m25s
[20:26:35.200] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:7:0)
[20:26:35.224] Build status: STARTED
[20:26:35.224] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:8:0) after 1m55s
[20:28:30.270] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:8:0)
[20:28:30.335] Build status: STARTED
[20:28:30.335] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:9:0) after 8m14s
[20:36:44.404] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:9:0)
[20:36:44.430] Build status: STARTED
[20:36:44.430] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:10:0) after 2m25s
[20:39:09.538] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:10:0)
[20:39:09.573] Build status: STARTED
[20:39:09.573] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:11:0) after 5m18s
[20:44:27.588] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:11:0)
[20:44:27.677] Build status: STARTED
[20:44:27.677] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:12:0) after 3m29s
[20:47:56.734] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:12:0)
[20:47:56.759] Build status: STARTED
[20:47:56.759] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:13:0) after 5m57s
[20:53:53.779] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:13:0)
[20:53:53.805] Build status: STARTED
[20:53:53.805] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:14:0) after 6m49s
[21:00:42.848] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:14:0)
[21:00:42.874] Build status: STARTED
[21:00:42.874] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:15:0) after 2m58s
[21:03:40.901] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:15:0)
[21:03:40.925] Build status: STARTED
[21:03:40.925] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:16:0) after 8m24s
[21:12:04.944] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:16:0)
[21:12:04.968] Build status: STARTED
[21:12:04.968] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:17:0) after 9m28s
[21:21:33.005] Handling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:17:0)
[21:21:33.047] Build status: STARTED
[21:21:33.047] Scheduling timer "check-buildbucket-build-status" (fuchsia/core.arm64-asan-e5a0ec7f:8930396180495955808:18:0) after 8m56s
[21:22:20.656] Received PubSub notification, asking Buildbucket for the build status
[21:22:20.703] Build:
{
"id": "8764966118351051681",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.arm64-asan"
},
"createdBy": "project:fuchsia",
"createTime": "2023-11-08T20:05:50.965627052Z",
"startTime": "2023-11-08T20:06:30.190467Z",
"endTime": "2023-11-08T21:22:17.462910Z",
"updateTime": "2023-11-08T21:22:17.462910Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "f93b8b468c436ceb2e7589cc91b31b418ca90bb1",
"ref": "refs/heads/main"
}
}
}
[21:22:20.703] Invocation finished in 1h16m31.167133404s with status SUCCEEDED