[60.437702] Initializing watchdogs
[60.437819]   /dev/watchdog0
[60.453179] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[60.457814] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[60.460212] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.463798] [001/155] (960s left) gem_exec_balancer (full-late)
[60.556627] Starting subtest: full-late
[65.210581] Subtest full-late: SUCCESS (4.654s)
[65.542719] [002/155] (955s left) vgem_basic (dmabuf-export)
[65.613262] Starting subtest: dmabuf-export
[65.648123] Subtest dmabuf-export: SUCCESS (0.040s)
[65.732763] [FACT vgem_basic (dmabuf-export)] new: kernel.kmod_is_loaded.vgem: true
[65.735746] [003/155] (955s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-upscaling)
[65.829300] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-upscaling
[65.833760] Subtest flip-64bpp-ytile-to-32bpp-ytile-upscaling: SKIP (0.000s)
[65.912042] [004/155] (955s left) kms_addfb_basic (too-high)
[66.011215] Starting subtest: too-high
[66.013190] Subtest too-high: SUCCESS (0.001s)
[66.107590] [005/155] (955s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[66.203413] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[66.207635] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[66.305506] [006/155] (954s left) perf_pmu (interrupts)
[66.347855] Starting subtest: interrupts
[67.430807] Subtest interrupts: SUCCESS (1.082s)
[67.534134] [007/155] (953s left) kms_frontbuffer_tracking (hdr-1p-primscrn-spr-indfb-draw-pwrite)
[67.633279] Starting subtest: hdr-1p-primscrn-spr-indfb-draw-pwrite
[67.637292] Subtest hdr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[67.732544] [008/155] (953s left) gem_exec_async (forked-writes)
[67.785130] Starting subtest: forked-writes
[67.787545] Starting dynamic subtest: rcs0
[67.814375] Dynamic subtest rcs0: SUCCESS (0.029s)
[67.825330] Starting dynamic subtest: bcs0
[67.840903] Dynamic subtest bcs0: SUCCESS (0.026s)
[67.851590] Starting dynamic subtest: vcs0
[67.864390] Dynamic subtest vcs0: SUCCESS (0.023s)
[67.876422] Starting dynamic subtest: vcs1
[67.888421] Dynamic subtest vcs1: SUCCESS (0.024s)
[67.897434] Starting dynamic subtest: vecs0
[67.910983] Dynamic subtest vecs0: SUCCESS (0.022s)
[67.920957] Starting dynamic subtest: ccs0
[67.936219] Dynamic subtest ccs0: SUCCESS (0.025s)
[67.938406] Subtest forked-writes: SUCCESS (0.151s)
[68.160706] [009/155] (953s left) syncobj_timeline (reset-during-wait-for-submit)
[68.217131] Starting subtest: reset-during-wait-for-submit
[68.321720] Subtest reset-during-wait-for-submit: SUCCESS (0.104s)
[68.407176] [010/155] (952s left) kms_cursor_edge_walk (128x128-top-edge)
[68.502704] Starting subtest: 128x128-top-edge
[68.504925] Starting dynamic subtest: pipe-A-eDP-1
[71.965595] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.461s)
[71.977641] Starting dynamic subtest: pipe-D-eDP-1
[75.189077] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.224s)
[75.191418] Subtest 128x128-top-edge: SUCCESS (6.688s)
[76.017907] [011/155] (945s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb101010-draw-mmap-cpu)
[76.118053] Starting subtest: fbcpsrhdr-rgb101010-draw-mmap-cpu
[76.122500] Subtest fbcpsrhdr-rgb101010-draw-mmap-cpu: SKIP (0.000s)
[76.208979] [012/155] (945s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[76.322416] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[83.979272] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.665s)
[84.116376] [013/155] (937s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[84.227970] Starting subtest: fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt
[84.232471] Subtest fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[84.346178] [014/155] (937s left) kms_chamelium_frames (dp-crc-multiple)
[84.739870] Subtest dp-crc-multiple: SKIP (0.000s)
[85.577540] [015/155] (935s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-indfb-plflip-blt)
[85.681905] Starting subtest: psrhdr-1p-primscrn-indfb-plflip-blt
[85.686331] Subtest psrhdr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[85.762900] [016/155] (935s left) kms_psr (fbc-pr-cursor-plane-move)
[85.864650] Starting subtest: fbc-pr-cursor-plane-move
[85.869202] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[85.937346] [017/155] (935s left) i915_pm_rps (min-max-config-loaded)
[85.994007] Starting subtest: min-max-config-loaded
[85.998259] Subtest min-max-config-loaded: SKIP (0.001s)
[86.090231] [018/155] (935s left) kms_psr (psr-cursor-plane-move)
[86.186681] Starting subtest: psr-cursor-plane-move
[86.188943] Starting dynamic subtest: eDP-1
[87.889528] Dynamic subtest eDP-1: SUCCESS (1.702s)
[87.891550] Subtest psr-cursor-plane-move: SUCCESS (1.702s)
[88.755755] [019/155] (932s left) kms_flip (flip-vs-fences-interruptible)
[88.857355] Starting subtest: flip-vs-fences-interruptible
[88.861758] Subtest flip-vs-fences-interruptible: SKIP (0.000s)
[88.964962] [020/155] (932s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0)
[89.064231] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0
[89.068162] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[89.160917] [021/155] (932s left) gen3_render_mixed_blits
[89.260882] [022/155] (932s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[89.355308] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc
[89.359579] Subtest fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[89.449927] [023/155] (932s left) gem_exec_reloc (basic-cpu-wc-active)
[89.502910] Subtest basic-cpu-wc-active: SKIP (0.000s)
[89.573932] [024/155] (932s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-blt)
[89.674537] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-blt
[94.131844] Subtest fbc-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (4.463s)
[95.358444] [025/155] (926s left) gem_exec_fence (long-history)
[95.783083] Starting subtest: long-history
[103.067148] Subtest long-history: SUCCESS (7.286s)
[103.706925] [026/155] (918s left) syncobj_wait (invalid-signal-one-illegal-handle)
[103.761847] Starting subtest: invalid-signal-one-illegal-handle
[103.764140] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[103.870801] [027/155] (918s left) gem_mmap_wc (read)
[103.936479] Subtest read: SKIP (0.000s)
[104.008484] [028/155] (918s left) kms_joiner (basic-ultra-joiner)
[104.110732] Starting subtest: basic-ultra-joiner
[104.115095] Subtest basic-ultra-joiner: SKIP (0.000s)
[104.175715] [029/155] (917s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite)
[104.285071] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite
[109.770442] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.491s)
[110.971844] [030/155] (911s left) gem_userptr_blits (dmabuf-unsync)
[111.047082] Subtest dmabuf-unsync: SKIP (0.000s)
[111.185953] [031/155] (911s left) gem_exec_capture (capture-recoverable)
[111.245156] Starting subtest: capture-recoverable
[111.249625] Subtest capture-recoverable: SUCCESS (0.003s)
[111.378532] [032/155] (910s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[111.486872] Starting subtest: hdr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[111.491283] Subtest hdr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[111.588239] [033/155] (910s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-mc-ccs)
[111.680610] Starting subtest: crc-primary-suspend-4-tiled-mtl-mc-ccs
[111.682958] Starting dynamic subtest: pipe-A-eDP-1
[143.889024] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.032s)
[143.900031] Starting dynamic subtest: pipe-B-eDP-1
[176.819164] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.788s)
[176.829873] Starting dynamic subtest: pipe-C-eDP-1
[209.796459] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.710s)
[209.813069] Starting dynamic subtest: pipe-D-eDP-1
[242.787134] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.672s)
[242.789547] Subtest crc-primary-suspend-4-tiled-mtl-mc-ccs: SUCCESS (14.206s)
[244.024583] [034/155] (778s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier-source-clamping)
[244.119373] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier-source-clamping
[244.124369] Subtest pixel-format-4-tiled-bmg-ccs-modifier-source-clamping: SKIP (0.000s)
[244.192388] [035/155] (778s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[244.286875] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[244.289166] Starting dynamic subtest: pipe-A-eDP-1
[244.310954] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.021s)
[244.321002] Starting dynamic subtest: pipe-B-eDP-1
[244.340783] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s)
[244.351217] Starting dynamic subtest: pipe-C-eDP-1
[244.373968] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.020s)
[244.384333] Starting dynamic subtest: pipe-D-eDP-1
[244.406097] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.020s)
[244.408440] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.085s)
[246.698082] [036/155] (775s left) perf (gen12-group-exclusive-stream-sample-oa)
[246.831233] Starting subtest: gen12-group-exclusive-stream-sample-oa
[246.852069] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.021s)
[246.903107] [037/155] (775s left) api_intel_bb (blit-reloc-purge-cache)
[246.952316] Starting subtest: blit-reloc-purge-cache
[246.957446] Subtest blit-reloc-purge-cache: SKIP (0.000s)
[247.063554] [038/155] (775s left) gem_mmap_wc (close)
[247.116059] Subtest close: SKIP (0.000s)
[247.178626] [039/155] (775s left) kms_cursor_crc (cursor-onscreen-32x10)
[247.356733] Starting subtest: cursor-onscreen-32x10
[247.405241] Subtest cursor-onscreen-32x10: SKIP (0.044s)
[247.647173] [040/155] (774s left) perf_pmu (pmu-read)
[247.687124] Starting subtest: pmu-read
[247.688918] Subtest pmu-read: SUCCESS (0.003s)
[247.788944] [041/155] (774s left) kms_cursor_legacy (forked-move)
[247.909462] Starting subtest: forked-move
[247.911896] Starting dynamic subtest: pipe-A
[253.430239] Dynamic subtest pipe-A: SUCCESS (5.459s)
[253.444048] Starting dynamic subtest: pipe-B
[258.916782] Dynamic subtest pipe-B: SUCCESS (5.484s)
[258.930044] Starting dynamic subtest: pipe-C
[264.406401] Dynamic subtest pipe-C: SUCCESS (5.482s)
[264.419554] Starting dynamic subtest: pipe-D
[269.899706] Dynamic subtest pipe-D: SUCCESS (5.494s)
[269.916283] Starting dynamic subtest: all-pipes
[275.413521] Dynamic subtest all-pipes: SUCCESS (5.511s)
[275.416535] Subtest forked-move: SUCCESS (27.440s)
[275.507107] [042/155] (747s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[275.624023] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[275.629070] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[275.706118] [043/155] (747s left) gem_bad_reloc (negative-reloc-lut)
[275.764550] Subtest negative-reloc-lut: SKIP (0.000s)
[275.835119] [044/155] (746s left) perf (invalid-oa-exponent)
[275.937512] Starting subtest: invalid-oa-exponent
[275.956423] Subtest invalid-oa-exponent: SUCCESS (0.017s)
[276.011563] [045/155] (746s left) kms_properties (invalid-properties-atomic)
[276.103272] Starting subtest: invalid-properties-atomic
[276.414420] Subtest invalid-properties-atomic: SUCCESS (0.312s)
[276.488914] [046/155] (746s left) gem_exec_params (cliprects_ptr-dirt)
[276.537688] Starting subtest: cliprects_ptr-dirt
[276.540091] Subtest cliprects_ptr-dirt: SUCCESS (0.000s)
[276.632135] [047/155] (746s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling)
[276.726246] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling
[276.729023] Starting dynamic subtest: pipe-A-default-mode
[279.441278] Dynamic subtest pipe-A-default-mode: SUCCESS (2.717s)
[279.444018] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (2.718s)
[280.285063] [048/155] (742s left) kms_psr (pr-primary-page-flip)
[280.380390] Starting subtest: pr-primary-page-flip
[280.385644] Subtest pr-primary-page-flip: SKIP (0.000s)
[280.467374] [049/155] (742s left) kms_psr (fbc-psr-basic)
[280.554379] Starting subtest: fbc-psr-basic
[280.557108] Starting dynamic subtest: eDP-1
[280.562338] Dynamic subtest eDP-1: SKIP (0.000s)
[280.567409] Subtest fbc-psr-basic: SKIP (0.001s)
[280.646368] [050/155] (742s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-fullscreen)
[280.745180] Starting subtest: psrhdr-2p-primscrn-spr-indfb-fullscreen
[280.749906] Subtest psrhdr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[280.846922] [051/155] (742s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[280.947325] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[280.952550] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[281.059798] [052/155] (742s left) kms_flip (2x-flip-vs-panning)
[281.164174] Starting subtest: 2x-flip-vs-panning
[281.172138] Subtest 2x-flip-vs-panning: SKIP (0.010s)
[281.300010] [053/155] (741s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[281.362676] Starting subtest: saturated-hostile-nopreempt
[281.365284] Starting dynamic subtest: rcs0
[281.415562] Dynamic subtest rcs0: SKIP (0.050s)
[281.428944] Starting dynamic subtest: bcs0
[281.433797] Dynamic subtest bcs0: SKIP (0.012s)
[281.444369] Starting dynamic subtest: vcs0
[281.448827] Dynamic subtest vcs0: SKIP (0.015s)
[281.458794] Starting dynamic subtest: vcs1
[281.463295] Dynamic subtest vcs1: SKIP (0.013s)
[281.473450] Starting dynamic subtest: vecs0
[281.477886] Dynamic subtest vecs0: SKIP (0.014s)
[281.487873] Starting dynamic subtest: ccs0
[281.492587] Dynamic subtest ccs0: SKIP (0.013s)
[281.497117] Subtest saturated-hostile-nopreempt: SKIP (0.120s)
[281.561821] [054/155] (741s left) gem_softpin (noreloc-interruptible)
[281.624302] Starting subtest: noreloc-interruptible
[287.095419] Subtest noreloc-interruptible: SUCCESS (5.418s)
[287.153975] [055/155] (736s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[287.254309] Starting subtest: psr-rgb565-draw-render
[294.443316] Subtest psr-rgb565-draw-render: SUCCESS (7.194s)
[294.557160] [056/155] (728s left) gem_userptr_blits (relocations)
[294.616690] Starting subtest: relocations
[294.621300] Subtest relocations: SKIP (0.001s)
[294.751864] [057/155] (728s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-render)
[294.862167] Starting subtest: fbcpsr-rgb101010-draw-render
[299.719755] Subtest fbcpsr-rgb101010-draw-render: SUCCESS (4.862s)
[299.845656] [058/155] (723s left) api_intel_bb (simple-bb-ctx)
[299.898995] Starting subtest: simple-bb-ctx
[299.909657] Subtest simple-bb-ctx: SUCCESS (0.012s)
[300.037172] [059/155] (723s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[300.145952] Starting subtest: hdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[300.150996] Subtest hdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[300.237433] [060/155] (723s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[300.341174] Starting subtest: fbchdr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[300.346314] Subtest fbchdr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[300.427733] [061/155] (723s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[300.535532] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[305.097857] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.569s)
[306.267225] [062/155] (717s left) syncobj_timeline (wait-all-delayed-signal)
[306.319569] Starting subtest: wait-all-delayed-signal
[306.421069] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[306.505521] [063/155] (717s left) gem_ctx_isolation (nonpriv-switch)
[306.554326] Starting subtest: nonpriv-switch
[306.557360] Starting dynamic subtest: rcs0
[306.847701] Dynamic subtest rcs0: SUCCESS (0.293s)
[306.859560] Starting dynamic subtest: bcs0
[307.134435] Dynamic subtest bcs0: SUCCESS (0.286s)
[307.147964] Starting dynamic subtest: vcs0
[307.435765] Dynamic subtest vcs0: SUCCESS (0.300s)
[307.446154] Starting dynamic subtest: vcs1
[309.531149] Dynamic subtest vcs1: SUCCESS (2.094s)
[309.543862] Starting dynamic subtest: vecs0
[311.497654] Dynamic subtest vecs0: SUCCESS (1.965s)
[311.508549] Starting dynamic subtest: ccs0
[313.542011] Dynamic subtest ccs0: SUCCESS (2.044s)
[313.544715] Subtest nonpriv-switch: SUCCESS (6.989s)
[313.789362] [064/155] (709s left) gem_exec_schedule (u-fairslice)
[313.864051] Starting subtest: u-fairslice
[313.866818] Starting dynamic subtest: rcs0
[315.944679] Dynamic subtest rcs0: SUCCESS (2.042s)
[315.956176] Starting dynamic subtest: bcs0
[317.920105] Dynamic subtest bcs0: SUCCESS (2.021s)
[317.932481] Starting dynamic subtest: vcs0
[319.940551] Dynamic subtest vcs0: SUCCESS (2.019s)
[319.951418] Starting dynamic subtest: vcs1
[321.962508] Dynamic subtest vcs1: SUCCESS (2.020s)
[321.974282] Starting dynamic subtest: vecs0
[323.983208] Dynamic subtest vecs0: SUCCESS (2.020s)
[323.993853] Starting dynamic subtest: ccs0
[326.006402] Dynamic subtest ccs0: SUCCESS (2.023s)
[326.008816] Subtest u-fairslice: SUCCESS (12.151s)
[326.304105] [065/155] (697s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[326.406016] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[333.787488] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.388s)
[333.926682] [066/155] (689s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt)
[334.034138] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt
[334.039080] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[334.123391] [067/155] (689s left) kms_sequence (queue-busy)
[334.228515] Starting subtest: queue-busy
[334.231266] Starting dynamic subtest: pipe-A-eDP-1
[336.166416] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.937s)
[336.178397] Starting dynamic subtest: pipe-B-eDP-1
[338.786991] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.619s)
[338.798131] Starting dynamic subtest: pipe-C-eDP-1
[341.394418] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.608s)
[341.405681] Starting dynamic subtest: pipe-D-eDP-1
[344.015168] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.619s)
[344.017881] Subtest queue-busy: SUCCESS (9.788s)
[344.903803] [068/155] (679s left) gem_create (create-ext-placement-all)
[345.070335] Starting subtest: create-ext-placement-all
[345.073572] Subtest create-ext-placement-all: SUCCESS (0.000s)
[345.177367] [069/155] (678s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-cur-indfb-draw-render)
[345.275725] Starting subtest: fbchdr-2p-primscrn-cur-indfb-draw-render
[345.280301] Subtest fbchdr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[345.356908] [070/155] (678s left) kms_pipe_stress (stress-xrgb8888-ytiled)
[345.465933] Starting subtest: stress-xrgb8888-ytiled
[345.471198] Subtest stress-xrgb8888-ytiled: SKIP (0.000s)
[345.542839] [071/155] (678s left) gem_render_copy (linear-to-vebox-y-tiled)
[345.612571] Starting subtest: linear-to-vebox-y-tiled
[345.618290] Subtest linear-to-vebox-y-tiled: SKIP (0.000s)
[345.799427] [072/155] (678s left) gem_unref_active_buffers
[346.010724] [073/155] (678s left) kms_vrr (flip-dpms)
[346.100646] Starting subtest: flip-dpms
[346.109290] Subtest flip-dpms: SKIP (0.000s)
[346.178913] [074/155] (678s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[346.284137] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[346.289382] Subtest psrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[346.384246] [075/155] (677s left) kms_psr (fbc-pr-sprite-plane-move)
[346.476451] Starting subtest: fbc-pr-sprite-plane-move
[346.481329] Subtest fbc-pr-sprite-plane-move: SKIP (0.000s)
[346.549180] [076/155] (677s left) kms_cursor_legacy (cursorb-vs-flipa-toggle)
[346.672880] Starting subtest: cursorB-vs-flipA-toggle
[346.678503] Subtest cursorB-vs-flipA-toggle: SKIP (0.001s)
[346.831512] [077/155] (677s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs-cc)
[346.929676] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs-cc
[346.932131] Starting dynamic subtest: pipe-A-eDP-1
[346.955420] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[346.966288] Starting dynamic subtest: pipe-B-eDP-1
[346.991154] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[347.001659] Starting dynamic subtest: pipe-C-eDP-1
[347.025251] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[347.035323] Starting dynamic subtest: pipe-D-eDP-1
[347.060728] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[347.064788] Subtest random-ccs-data-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[349.195706] [078/155] (675s left) i915_drm_fdinfo (virtual-busy-hang)
[349.240397] Starting subtest: virtual-busy-hang
[349.245371] Subtest virtual-busy-hang: SKIP (0.000s)
[349.312397] [079/155] (675s left) kms_frontbuffer_tracking (hdr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[349.409939] Starting subtest: hdr-2p-primscrn-spr-indfb-draw-mmap-gtt
[349.414539] Subtest hdr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[349.508231] [080/155] (674s left) kms_pm_rpm (modeset-non-lpsp)
[351.330891] Starting subtest: modeset-non-lpsp
[352.488064] Subtest modeset-non-lpsp: SKIP (1.154s)
[352.898489] [081/155] (671s left) gen9_exec_parse (batch-invalid-length)
[352.952421] Subtest batch-invalid-length: SKIP (0.000s)
[353.013899] [082/155] (671s left) drm_read (invalid-buffer)
[353.150552] Starting subtest: invalid-buffer
[353.153087] Subtest invalid-buffer: SUCCESS (0.000s)
[353.274900] [083/155] (671s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[353.378029] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[353.383334] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[353.467017] [084/155] (671s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-shrfb-draw-pwrite)
[353.581525] Starting subtest: psrhdr-2p-scndscrn-pri-shrfb-draw-pwrite
[353.586661] Subtest psrhdr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[353.670338] [085/155] (670s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[353.776518] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[353.781402] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[353.869608] [086/155] (670s left) kms_flip (flip-vs-suspend-interruptible)
[353.960797] Starting subtest: flip-vs-suspend-interruptible
[353.963249] Starting dynamic subtest: A-eDP1
[515.617487] Dynamic subtest A-eDP1: SUCCESS (12.120s)
[515.620329] Subtest flip-vs-suspend-interruptible: SUCCESS (12.123s)
[515.748234] [087/155] (509s left) kms_big_fb (yf-tiled-32bpp-rotate-0)
[515.852040] Starting subtest: yf-tiled-32bpp-rotate-0
[515.856517] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s)
[515.961755] [088/155] (508s left) kms_plane_scaling (plane-scaler-unity-scaling-with-pixel-format)
[516.059163] Starting subtest: plane-scaler-unity-scaling-with-pixel-format
[516.061883] Starting dynamic subtest: pipe-A
[517.216649] Dynamic subtest pipe-A: SUCCESS (1.163s)
[517.233623] Starting dynamic subtest: pipe-B
[519.521146] Dynamic subtest pipe-B: SUCCESS (2.299s)
[519.531601] Starting dynamic subtest: pipe-C
[520.699921] Dynamic subtest pipe-C: SUCCESS (1.176s)
[520.710526] Starting dynamic subtest: pipe-D
[521.934814] Dynamic subtest pipe-D: SUCCESS (1.232s)
[521.937559] Subtest plane-scaler-unity-scaling-with-pixel-format: SUCCESS (5.877s)
[523.134024] [089/155] (501s left) gem_exec_whisper (basic-queues-priority-all)
[523.193951] Starting subtest: basic-queues-priority-all
[545.098719] Subtest basic-queues-priority-all: SUCCESS (21.889s)
[545.297118] [090/155] (479s left) gem_spin_batch (spin-each)
[545.369005] Starting subtest: spin-each
[548.752023] Subtest spin-each: SUCCESS (3.379s)
[550.800995] [091/155] (474s left) intel_hwmon (hwmon-read)
[550.861331] Subtest hwmon-read: SKIP (0.000s)
[550.922139] [092/155] (474s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[551.190418] Starting subtest: cursor-rapid-movement-512x512
[551.194807] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[551.359006] [093/155] (473s left) kms_concurrent (multi-plane-atomic-lowres)
[551.451431] Starting subtest: multi-plane-atomic-lowres
[551.453877] Starting dynamic subtest: pipe-A-eDP-1
[551.955102] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.503s)
[551.972656] Starting dynamic subtest: pipe-B-eDP-1
[553.189060] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.232s)
[553.204292] Starting dynamic subtest: pipe-C-eDP-1
[554.409031] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.219s)
[554.420120] Starting dynamic subtest: pipe-D-eDP-1
[555.632070] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.221s)
[555.634947] Subtest multi-plane-atomic-lowres: SUCCESS (4.180s)
[556.471823] [094/155] (468s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-cur-indfb-draw-pwrite)
[556.571427] Starting subtest: fbchdr-1p-primscrn-cur-indfb-draw-pwrite
[556.576580] Subtest fbchdr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[556.670341] [095/155] (468s left) gem_ctx_param (non-root-set)
[556.718846] Starting subtest: non-root-set
[556.734941] Subtest non-root-set: SUCCESS (0.016s)
[556.824143] [096/155] (468s left) kms_frontbuffer_tracking (hdr-rgb565-draw-pwrite)
[556.925278] Starting subtest: hdr-rgb565-draw-pwrite
[556.930085] Subtest hdr-rgb565-draw-pwrite: SKIP (0.000s)
[557.024022] [097/155] (468s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-render)
[557.114299] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-render
[557.118982] Subtest fbchdr-1p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[557.212677] [098/155] (468s left) i915_hangman (engine-engine-error)
[557.273438] Starting subtest: engine-engine-error
[557.275946] Starting dynamic subtest: rcs0
[558.690072] Dynamic subtest rcs0: SUCCESS (1.415s)
[558.704445] Starting dynamic subtest: bcs0
[560.670776] Dynamic subtest bcs0: SUCCESS (1.978s)
[560.682813] Starting dynamic subtest: vcs0
[562.655967] Dynamic subtest vcs0: SUCCESS (1.981s)
[562.668956] Starting dynamic subtest: vcs1
[564.704279] Dynamic subtest vcs1: SUCCESS (2.044s)
[564.718221] Starting dynamic subtest: vecs0
[566.687858] Dynamic subtest vecs0: SUCCESS (1.980s)
[566.702449] Starting dynamic subtest: ccs0
[568.673148] Dynamic subtest ccs0: SUCCESS (1.981s)
[568.676312] Subtest engine-engine-error: SUCCESS (11.398s)
[568.761203] [099/155] (456s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[568.862016] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf
[568.864294] Starting dynamic subtest: pipe-A-eDP-1
[585.380005] Dynamic subtest pipe-A-eDP-1: SUCCESS (16.515s)
[585.391248] Starting dynamic subtest: pipe-B-eDP-1
[602.582793] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.197s)
[602.585615] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (33.716s)
[603.470461] [100/155] (421s left) perf (oa-exponents)
[603.562714] Starting subtest: oa-exponents
[603.565493] Starting dynamic subtest: 0-rcs0
[605.346428] Dynamic subtest 0-rcs0: SUCCESS (1.781s)
[605.358066] Starting dynamic subtest: 1-vcs1
[607.176180] Dynamic subtest 1-vcs1: SUCCESS (1.828s)
[607.179279] Subtest oa-exponents: SUCCESS (3.611s)
[607.229679] [101/155] (418s left) kms_atomic_transition (modeset-transition)
[607.325328] Starting subtest: modeset-transition
[607.328147] Starting dynamic subtest: 1x-outputs
[618.379050] Dynamic subtest 1x-outputs: SUCCESS (11.057s)
[618.381899] Subtest modeset-transition: SUCCESS (11.058s)
[619.250461] [102/155] (406s left) gem_mmap_gtt (big-bo-tiledx)
[619.310969] Subtest big-bo-tiledX: SKIP (0.000s)
[619.368724] [103/155] (406s left) kms_selftest (drm_format)
[619.404590] Starting subtest: drm_format
[619.418183] Starting dynamic subtest: drm_test_format_block_width_invalid
[619.531635] Dynamic subtest drm_test_format_block_width_invalid: SUCCESS (0.112s)
[619.543796] Starting dynamic subtest: drm_test_format_block_width_one_plane
[619.623238] Dynamic subtest drm_test_format_block_width_one_plane: SUCCESS (0.092s)
[619.635972] Starting dynamic subtest: drm_test_format_block_width_two_plane
[619.715593] Dynamic subtest drm_test_format_block_width_two_plane: SUCCESS (0.092s)
[619.727396] Starting dynamic subtest: drm_test_format_block_width_three_plane
[619.798283] Dynamic subtest drm_test_format_block_width_three_plane: SUCCESS (0.079s)
[619.811302] Starting dynamic subtest: drm_test_format_block_width_tiled
[619.886193] Dynamic subtest drm_test_format_block_width_tiled: SUCCESS (0.088s)
[619.899617] Starting dynamic subtest: drm_test_format_block_height_invalid
[619.974222] Dynamic subtest drm_test_format_block_height_invalid: SUCCESS (0.086s)
[619.986201] Starting dynamic subtest: drm_test_format_block_height_one_plane
[620.061144] Dynamic subtest drm_test_format_block_height_one_plane: SUCCESS (0.086s)
[620.072855] Starting dynamic subtest: drm_test_format_block_height_two_plane
[620.150014] Dynamic subtest drm_test_format_block_height_two_plane: SUCCESS (0.087s)
[620.162293] Starting dynamic subtest: drm_test_format_block_height_three_plane
[620.241158] Dynamic subtest drm_test_format_block_height_three_plane: SUCCESS (0.090s)
[620.254079] Starting dynamic subtest: drm_test_format_block_height_tiled
[620.343096] Dynamic subtest drm_test_format_block_height_tiled: SUCCESS (0.101s)
[620.354124] Starting dynamic subtest: drm_test_format_min_pitch_invalid
[620.444974] Dynamic subtest drm_test_format_min_pitch_invalid: SUCCESS (0.102s)
[620.456181] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_8bpp
[620.538181] Dynamic subtest drm_test_format_min_pitch_one_plane_8bpp: SUCCESS (0.092s)
[620.549024] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_16bpp
[620.623929] Dynamic subtest drm_test_format_min_pitch_one_plane_16bpp: SUCCESS (0.084s)
[620.636129] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_24bpp
[620.712577] Dynamic subtest drm_test_format_min_pitch_one_plane_24bpp: SUCCESS (0.087s)
[620.723293] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_32bpp
[620.811884] Dynamic subtest drm_test_format_min_pitch_one_plane_32bpp: SUCCESS (0.098s)
[620.822588] Starting dynamic subtest: drm_test_format_min_pitch_two_plane
[620.892506] Dynamic subtest drm_test_format_min_pitch_two_plane: SUCCESS (0.079s)
[620.904295] Starting dynamic subtest: drm_test_format_min_pitch_three_plane_8bpp
[620.979848] Dynamic subtest drm_test_format_min_pitch_three_plane_8bpp: SUCCESS (0.087s)
[620.991569] Starting dynamic subtest: drm_test_format_min_pitch_tiled
[621.080139] Dynamic subtest drm_test_format_min_pitch_tiled: SUCCESS (0.099s)
[621.082315] Subtest drm_format: SUCCESS (1.678s)
[621.232487] [104/155] (404s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0)
[621.326420] Starting subtest: linear-max-hw-stride-32bpp-rotate-0
[622.451803] Subtest linear-max-hw-stride-32bpp-rotate-0: SUCCESS (1.125s)
[622.573820] [105/155] (403s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[622.669064] Starting subtest: psrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[622.673114] Subtest psrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[622.770691] [106/155] (402s left) kms_plane (pixel-format-linear-modifier)
[622.866234] Starting subtest: pixel-format-linear-modifier
[622.891895] Starting dynamic subtest: pipe-A-plane-0
[623.524857] Dynamic subtest pipe-A-plane-0: SUCCESS (0.633s)
[623.535492] Starting dynamic subtest: pipe-A-plane-3
[624.003137] Dynamic subtest pipe-A-plane-3: SUCCESS (0.477s)
[624.013896] Starting dynamic subtest: pipe-A-plane-5
[624.212953] Dynamic subtest pipe-A-plane-5: SUCCESS (0.209s)
[625.328406] Starting dynamic subtest: pipe-B-plane-0
[625.999473] Dynamic subtest pipe-B-plane-0: SUCCESS (0.678s)
[626.010309] Starting dynamic subtest: pipe-B-plane-3
[626.485185] Dynamic subtest pipe-B-plane-3: SUCCESS (0.487s)
[626.495431] Starting dynamic subtest: pipe-B-plane-5
[626.696763] Dynamic subtest pipe-B-plane-5: SUCCESS (0.210s)
[627.022626] Subtest pixel-format-linear-modifier: SUCCESS (4.158s)
[627.902462] [107/155] (397s left) kms_frontbuffer_tracking (fbchdr-rgb565-draw-mmap-gtt)
[628.007509] Starting subtest: fbchdr-rgb565-draw-mmap-gtt
[628.012057] Subtest fbchdr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[628.095702] [108/155] (397s left) gem_exec_whisper (basic-fds)
[628.151356] Starting subtest: basic-fds
[635.683352] Subtest basic-fds: SUCCESS (7.529s)
[635.881288] [109/155] (389s left) syncobj_timeline (etime-single-wait-all-submitted)
[635.941276] Starting subtest: etime-single-wait-all-submitted
[636.046579] Subtest etime-single-wait-all-submitted: SUCCESS (0.104s)
[636.125802] [110/155] (389s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[636.231136] Starting subtest: hdr-1p-offscreen-pri-indfb-draw-mmap-gtt
[636.236525] Subtest hdr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[636.322063] [111/155] (389s left) kms_flip (2x-flip-vs-panning-vs-hang)
[636.411841] Starting subtest: 2x-flip-vs-panning-vs-hang
[636.416167] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.002s)
[636.516290] [112/155] (389s left) dumb_buffer (create-clear)
[636.568287] Starting subtest: create-clear
[671.130978] Subtest create-clear: SUCCESS (34.510s)
[671.181237] [113/155] (354s left) gem_mmap_offset (open-flood)
[671.242809] Starting subtest: open-flood
[692.733511] Subtest open-flood: SUCCESS (21.489s)
[692.834779] [114/155] (333s left) vgem_basic (dmabuf-fence-before)
[692.882591] Starting subtest: dmabuf-fence-before
[692.884764] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[692.941814] [115/155] (333s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-shrfb-draw-pwrite)
[693.047975] Starting subtest: psrhdr-1p-primscrn-pri-shrfb-draw-pwrite
[693.052441] Subtest psrhdr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[693.130116] [116/155] (332s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[693.258131] Starting subtest: flip-vs-cursor-legacy
[700.881003] Subtest flip-vs-cursor-legacy: SUCCESS (7.619s)
[701.722090] [117/155] (324s left) kms_hdmi_inject (inject-4k)
[702.852019] Starting subtest: inject-4k
[703.202791] Subtest inject-4k: SUCCESS (0.352s)
[703.606540] [118/155] (322s left) kms_chamelium_hpd (hdmi-hpd-storm)
[703.988723] Subtest hdmi-hpd-storm: SKIP (0.000s)
[704.844058] [119/155] (321s left) prime_busy (before-wait)
[704.906284] Starting subtest: before-wait
[704.909138] Starting dynamic subtest: rcs0
[704.937126] Dynamic subtest rcs0: SUCCESS (0.030s)
[704.948446] Starting dynamic subtest: bcs0
[704.988961] Dynamic subtest bcs0: SUCCESS (0.051s)
[705.001328] Starting dynamic subtest: vcs0
[705.030035] Dynamic subtest vcs0: SUCCESS (0.041s)
[705.041267] Starting dynamic subtest: vcs1
[705.071764] Dynamic subtest vcs1: SUCCESS (0.041s)
[705.083442] Starting dynamic subtest: vecs0
[705.113789] Dynamic subtest vecs0: SUCCESS (0.041s)
[705.125370] Starting dynamic subtest: ccs0
[705.156712] Dynamic subtest ccs0: SUCCESS (0.042s)
[705.265253] Subtest before-wait: SUCCESS (0.360s)
[705.344528] [120/155] (320s left) kms_feature_discovery (display-2x)
[705.431096] Starting subtest: display-2x
[705.436319] Subtest display-2x: SKIP (0.000s)
[705.506001] [121/155] (320s left) gem_softpin (32b-excludes-last-page)
[705.561175] Starting subtest: 32b-excludes-last-page
[705.566331] Subtest 32b-excludes-last-page: SUCCESS (0.005s)
[705.702478] [122/155] (320s left) kms_lease (lease-revoke)
[705.792325] Starting subtest: lease-revoke
[705.795033] Starting dynamic subtest: pipe-A-eDP-1
[705.827678] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.036s)
[705.841836] Starting dynamic subtest: pipe-B-eDP-1
[705.859805] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.031s)
[705.870831] Starting dynamic subtest: pipe-C-eDP-1
[705.892165] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.030s)
[705.904638] Starting dynamic subtest: pipe-D-eDP-1
[705.919439] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.027s)
[705.922336] Subtest lease-revoke: SUCCESS (0.129s)
[706.061863] [123/155] (320s left) kms_flip (flip-vs-rmfb)
[706.151768] Starting subtest: flip-vs-rmfb
[706.154298] Starting dynamic subtest: A-eDP1
[714.851084] Dynamic subtest A-eDP1: SUCCESS (8.701s)
[714.863803] Starting dynamic subtest: B-eDP1
[723.493288] Dynamic subtest B-eDP1: SUCCESS (8.639s)
[723.504704] Starting dynamic subtest: C-eDP1
[732.117720] Dynamic subtest C-eDP1: SUCCESS (8.620s)
[732.129845] Starting dynamic subtest: D-eDP1
[740.743726] Dynamic subtest D-eDP1: SUCCESS (8.624s)
[740.748731] Subtest flip-vs-rmfb: SUCCESS (34.594s)
[741.945699] [124/155] (284s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-pri-indfb-draw-pwrite)
[742.052543] Starting subtest: fbcpsrhdr-1p-primscrn-pri-indfb-draw-pwrite
[742.058056] Subtest fbcpsrhdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[742.144233] [125/155] (284s left) syncobj_timeline (multi-wait-all-signaled)
[742.198102] Starting subtest: multi-wait-all-signaled
[742.200414] Subtest multi-wait-all-signaled: SUCCESS (0.000s)
[742.303700] [126/155] (284s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-shrfb-draw-pwrite)
[742.393842] Starting subtest: fbchdr-2p-scndscrn-pri-shrfb-draw-pwrite
[742.398539] Subtest fbchdr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[742.490021] [127/155] (284s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[742.589276] Starting subtest: x-tiled-64bpp-rotate-180
[744.256281] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.669s)
[744.412934] [128/155] (282s left) gem_exec_schedule (noreorder)
[744.594002] Starting subtest: noreorder
[744.596205] Starting dynamic subtest: rcs0
[744.650592] Dynamic subtest rcs0: SUCCESS (0.057s)
[744.664117] Starting dynamic subtest: vcs0
[745.725419] Dynamic subtest vcs0: SUCCESS (1.070s)
[745.739629] Starting dynamic subtest: vcs1
[747.721075] Dynamic subtest vcs1: SUCCESS (1.993s)
[747.735280] Starting dynamic subtest: vecs0
[749.696467] Dynamic subtest vecs0: SUCCESS (1.972s)
[749.710844] Starting dynamic subtest: ccs0
[749.768538] Dynamic subtest ccs0: SUCCESS (0.071s)
[749.771441] Subtest noreorder: SUCCESS (5.177s)
[749.956127] [129/155] (276s left) i915_query (query-topology-matches-eu-total)
[750.009106] Starting subtest: query-topology-matches-eu-total
[750.011598] Subtest query-topology-matches-eu-total: SUCCESS (0.000s)
[750.124413] [130/155] (276s left) sw_sync (alloc_merge_fence)
[750.155696] Starting subtest: alloc_merge_fence
[750.158150] Subtest alloc_merge_fence: SUCCESS (0.000s)
[750.214964] [131/155] (276s left) gem_mmap_wc (bad-size)
[750.268014] Subtest bad-size: SKIP (0.000s)
[750.326559] [132/155] (276s left) sysfs_heartbeat_interval (nopreempt)
[750.384996] Starting subtest: nopreempt
[750.387453] Starting dynamic subtest: vecs0
[758.719102] Dynamic subtest vecs0: SUCCESS (8.331s)
[758.733070] Starting dynamic subtest: ccs0
[762.727854] Dynamic subtest ccs0: SUCCESS (4.007s)
[762.740906] Starting dynamic subtest: vcs0
[771.714303] Dynamic subtest vcs0: SUCCESS (8.983s)
[771.728289] Starting dynamic subtest: bcs0
[775.625938] Dynamic subtest bcs0: SUCCESS (3.914s)
[775.637814] Starting dynamic subtest: rcs0
[779.682295] Dynamic subtest rcs0: SUCCESS (4.053s)
[779.694227] Starting dynamic subtest: vcs1
[789.761310] Dynamic subtest vcs1: SUCCESS (10.079s)
[789.764310] Subtest nopreempt: SUCCESS (39.380s)
[789.847562] [133/155] (236s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format)
[789.941177] Starting subtest: plane-upscale-factor-0-25-with-pixel-format
[789.944106] Starting dynamic subtest: pipe-A
[790.987826] Dynamic subtest pipe-A: SUCCESS (1.050s)
[790.999881] Starting dynamic subtest: pipe-B
[793.117036] Dynamic subtest pipe-B: SUCCESS (2.128s)
[793.129321] Starting dynamic subtest: pipe-C
[794.313112] Dynamic subtest pipe-C: SUCCESS (1.195s)
[794.325140] Starting dynamic subtest: pipe-D
[795.545290] Dynamic subtest pipe-D: SUCCESS (1.230s)
[795.548315] Subtest plane-upscale-factor-0-25-with-pixel-format: SUCCESS (5.606s)
[796.735272] [134/155] (230s left) kms_addfb_basic (basic-x-tiled-legacy)
[796.789823] Starting subtest: basic-x-tiled-legacy
[796.794981] Subtest basic-x-tiled-legacy: SKIP (0.000s)
[796.925336] [135/155] (229s left) kms_content_protection (uevent)
[797.077520] Starting subtest: uevent
[797.083143] Subtest uevent: SKIP (0.000s)
[797.201992] [136/155] (229s left) kms_rotation_crc (sprite-rotation-90)
[797.295687] Starting subtest: sprite-rotation-90
[797.301059] Subtest sprite-rotation-90: SKIP (0.001s)
[797.367707] [137/155] (229s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-fullscreen)
[797.464864] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-fullscreen
[797.469320] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[797.559755] [138/155] (229s left) gem_userptr_blits (forbidden-operations)
[797.627142] Starting subtest: forbidden-operations
[797.631821] Subtest forbidden-operations: SKIP (0.000s)
[797.738529] [139/155] (229s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[797.790587] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[797.893327] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.103s)
[797.978191] [140/155] (229s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[798.083846] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[798.088507] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[798.182643] [141/155] (228s left) kms_big_fb (4-tiled-64bpp-rotate-180)
[798.283990] Starting subtest: 4-tiled-64bpp-rotate-180
[799.953116] Subtest 4-tiled-64bpp-rotate-180: SUCCESS (1.670s)
[800.114425] [142/155] (227s left) gem_mmap_gtt (big-copy-xy)
[800.187288] Subtest big-copy-XY: SKIP (0.000s)
[800.243394] [143/155] (226s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs)
[800.332410] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs
[800.334707] Starting dynamic subtest: pipe-A-eDP-1
[800.353713] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[800.365800] Starting dynamic subtest: pipe-B-eDP-1
[800.385829] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[800.396567] Starting dynamic subtest: pipe-C-eDP-1
[800.416175] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[800.426745] Starting dynamic subtest: pipe-D-eDP-1
[800.446903] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[800.449048] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SUCCESS (0.005s)
[802.603875] [144/155] (224s left) gem_mmap_gtt (cpuset-basic-small-copy)
[802.659125] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[802.719656] [145/155] (224s left) kms_frontbuffer_tracking (psrhdr-suspend)
[802.818327] Starting subtest: psrhdr-suspend
[802.823334] Subtest psrhdr-suspend: SKIP (0.000s)
[802.909738] [146/155] (224s left) vgem_basic (second-client)
[802.949313] Starting subtest: second-client
[802.972083] Subtest second-client: SUCCESS (0.022s)
[803.043393] [147/155] (224s left) kms_big_fb (y-tiled-64bpp-rotate-0)
[803.147051] Starting subtest: y-tiled-64bpp-rotate-0
[803.152035] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s)
[803.248445] [148/155] (224s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-msflip-blt)
[803.348723] Starting subtest: psr-1p-primscrn-indfb-msflip-blt
[810.755110] Subtest psr-1p-primscrn-indfb-msflip-blt: SUCCESS (7.412s)
[810.885471] [149/155] (216s left) gem_userptr_blits (vma-merge)
[810.964821] Starting subtest: vma-merge
[811.006875] Subtest vma-merge: SUCCESS (0.042s)
[811.147438] [150/155] (216s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[811.272933] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[829.486006] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (18.212s)
[830.370227] [151/155] (197s left) gem_exec_params (invalid-fence-in-submit)
[830.426628] Starting subtest: invalid-fence-in-submit
[830.432054] Subtest invalid-fence-in-submit: SUCCESS (0.003s)
[830.545278] [152/155] (197s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[830.640255] Starting subtest: fbc-psr2-cursor-plane-update-sf
[830.642693] Starting dynamic subtest: pipe-A-eDP-1
[830.716378] Dynamic subtest pipe-A-eDP-1: SKIP (0.078s)
[830.728074] Starting dynamic subtest: pipe-B-eDP-1
[831.843794] Dynamic subtest pipe-B-eDP-1: SKIP (1.124s)
[831.848726] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.204s)
[833.034006] [153/155] (194s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-shrfb-draw-render)
[833.137725] Starting subtest: fbcpsrhdr-2p-primscrn-pri-shrfb-draw-render
[833.142188] Subtest fbcpsrhdr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[833.228487] [154/155] (194s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[833.326004] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[833.331340] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[834.462205] [155/155] (193s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[834.558328] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[834.563949] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[834.660626] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_balancer
results: parsing output: 1/ for test: vgem_basic
results: parsing output: 2/ for test: kms_flip_scaled_crc
results: parsing output: 3/ for test: kms_addfb_basic
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: perf_pmu
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: gem_exec_async
results: parsing output: 8/ for test: syncobj_timeline
results: parsing output: 9/ for test: kms_cursor_edge_walk
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: kms_chamelium_frames
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_psr
results: parsing output: 16/ for test: i915_pm_rps
results: parsing output: 17/ for test: kms_psr
results: parsing output: 18/ for test: kms_flip
results: parsing output: 19/ for test: kms_big_fb
results: parsing output: 20/ for test: gen3_render_mixed_blits
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: gem_exec_reloc
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: gem_exec_fence
results: parsing output: 25/ for test: syncobj_wait
results: parsing output: 26/ for test: gem_mmap_wc
results: parsing output: 27/ for test: kms_joiner
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: gem_userptr_blits
results: parsing output: 30/ for test: gem_exec_capture
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_ccs
results: parsing output: 33/ for test: kms_plane
results: parsing output: 34/ for test: kms_ccs
results: parsing output: 35/ for test: perf
results: parsing output: 36/ for test: api_intel_bb
results: parsing output: 37/ for test: gem_mmap_wc
results: parsing output: 38/ for test: kms_cursor_crc
results: parsing output: 39/ for test: perf_pmu
results: parsing output: 40/ for test: kms_cursor_legacy
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: gem_bad_reloc
results: parsing output: 43/ for test: perf
results: parsing output: 44/ for test: kms_properties
results: parsing output: 45/ for test: gem_exec_params
results: parsing output: 46/ for test: kms_flip_scaled_crc
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: kms_psr
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_big_fb
results: parsing output: 51/ for test: kms_flip
results: parsing output: 52/ for test: gem_ctx_persistence
results: parsing output: 53/ for test: gem_softpin
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: gem_userptr_blits
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: api_intel_bb
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: syncobj_timeline
results: parsing output: 62/ for test: gem_ctx_isolation
results: parsing output: 63/ for test: gem_exec_schedule
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_sequence
results: parsing output: 67/ for test: gem_create
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: kms_pipe_stress
results: parsing output: 70/ for test: gem_render_copy
results: parsing output: 71/ for test: gem_unref_active_buffers
results: parsing output: 72/ for test: kms_vrr
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_psr
results: parsing output: 75/ for test: kms_cursor_legacy
results: parsing output: 76/ for test: kms_ccs
results: parsing output: 77/ for test: i915_drm_fdinfo
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_pm_rpm
results: parsing output: 80/ for test: gen9_exec_parse
results: parsing output: 81/ for test: drm_read
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_flip
results: parsing output: 86/ for test: kms_big_fb
results: parsing output: 87/ for test: kms_plane_scaling
results: parsing output: 88/ for test: gem_exec_whisper
results: parsing output: 89/ for test: gem_spin_batch
results: parsing output: 90/ for test: intel_hwmon
results: parsing output: 91/ for test: kms_cursor_crc
results: parsing output: 92/ for test: kms_concurrent
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: gem_ctx_param
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: i915_hangman
results: parsing output: 98/ for test: kms_psr2_sf
results: parsing output: 99/ for test: perf
results: parsing output: 100/ for test: kms_atomic_transition
results: parsing output: 101/ for test: gem_mmap_gtt
results: parsing output: 102/ for test: kms_selftest
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_plane
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: gem_exec_whisper
results: parsing output: 108/ for test: syncobj_timeline
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_flip
results: parsing output: 111/ for test: dumb_buffer
results: parsing output: 112/ for test: gem_mmap_offset
results: parsing output: 113/ for test: vgem_basic
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_cursor_legacy
results: parsing output: 116/ for test: kms_hdmi_inject
results: parsing output: 117/ for test: kms_chamelium_hpd
results: parsing output: 118/ for test: prime_busy
results: parsing output: 119/ for test: kms_feature_discovery
results: parsing output: 120/ for test: gem_softpin
results: parsing output: 121/ for test: kms_lease
results: parsing output: 122/ for test: kms_flip
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: syncobj_timeline
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: kms_big_fb
results: parsing output: 127/ for test: gem_exec_schedule
results: parsing output: 128/ for test: i915_query
results: parsing output: 129/ for test: sw_sync
results: parsing output: 130/ for test: gem_mmap_wc
results: parsing output: 131/ for test: sysfs_heartbeat_interval
results: parsing output: 132/ for test: kms_plane_scaling
results: parsing output: 133/ for test: kms_addfb_basic
results: parsing output: 134/ for test: kms_content_protection
results: parsing output: 135/ for test: kms_rotation_crc
results: parsing output: 136/ for test: kms_frontbuffer_tracking
results: parsing output: 137/ for test: gem_userptr_blits
results: parsing output: 138/ for test: syncobj_timeline
results: parsing output: 139/ for test: kms_frontbuffer_tracking
results: parsing output: 140/ for test: kms_big_fb
results: parsing output: 141/ for test: gem_mmap_gtt
results: parsing output: 142/ for test: kms_ccs
results: parsing output: 143/ for test: gem_mmap_gtt
results: parsing output: 144/ for test: kms_frontbuffer_tracking
results: parsing output: 145/ for test: vgem_basic
results: parsing output: 146/ for test: kms_big_fb
results: parsing output: 147/ for test: kms_frontbuffer_tracking
results: parsing output: 148/ for test: gem_userptr_blits
results: parsing output: 149/ for test: kms_cursor_legacy
results: parsing output: 150/ for test: gem_exec_params
results: parsing output: 151/ for test: kms_psr2_sf
results: parsing output: 152/ for test: kms_frontbuffer_tracking
results: parsing output: 153/ for test: kms_ccs
results: parsing output: 154/ for test: kms_frontbuffer_tracking
Done.