[59.542545] Initializing watchdogs
[59.542608]   /dev/watchdog0
[59.556757] [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]
[59.561100] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.563992] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.567210] [001/133] (960s left) kms_ccs (crc-primary-basic-4-tiled-lnl-ccs)
[59.683745] Starting subtest: crc-primary-basic-4-tiled-lnl-ccs
[59.688275] Subtest crc-primary-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[60.858420] [002/133] (959s left) perf_pmu (busy-start)
[60.902136] Starting subtest: busy-start
[60.904469] Starting dynamic subtest: rcs0
[63.453284] Dynamic subtest rcs0: SUCCESS (2.551s)
[63.462172] Starting dynamic subtest: bcs0
[66.021732] Dynamic subtest bcs0: SUCCESS (2.549s)
[66.030577] Starting dynamic subtest: vcs0
[69.909342] Dynamic subtest vcs0: SUCCESS (3.904s)
[69.919170] Starting dynamic subtest: vcs1
[73.941340] Dynamic subtest vcs1: SUCCESS (4.031s)
[73.950162] Starting dynamic subtest: vecs0
[77.909878] Dynamic subtest vecs0: SUCCESS (3.967s)
[77.919206] Starting dynamic subtest: ccs0
[80.458689] Dynamic subtest ccs0: SUCCESS (2.549s)
[80.461941] Subtest busy-start: SUCCESS (19.557s)
[80.564190] [003/133] (939s left) kms_pipe_b_c_ivb (pipe-b-dpms-off-modeset-pipe-c)
[80.632258] Subtest pipe-B-dpms-off-modeset-pipe-C: SKIP (0.000s)
[80.694266] [004/133] (939s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[80.790725] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[80.794680] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.000s)
[80.856192] [005/133] (939s left) gem_exec_reloc (basic-write-read-active)
[80.917848] Subtest basic-write-read-active: SKIP (0.000s)
[80.987589] [006/133] (939s left) gem_mmap_gtt (basic-small-bo-tiledx)
[81.039490] Subtest basic-small-bo-tiledX: SKIP (0.000s)
[81.099135] [007/133] (939s left) gem_softpin (allocator-nopin-reserve)
[81.158738] Starting subtest: allocator-nopin-reserve
[81.268559] Subtest allocator-nopin-reserve: SUCCESS (0.109s)
[81.386644] [008/133] (938s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5)
[81.476070] Starting subtest: planes-unity-scaling-downscale-factor-0-5
[81.478469] Starting dynamic subtest: pipe-A
[81.498678] Dynamic subtest pipe-A: SKIP (0.018s)
[81.507755] Starting dynamic subtest: pipe-B
[81.540503] Dynamic subtest pipe-B: SKIP (0.042s)
[81.548910] Starting dynamic subtest: pipe-C
[81.576706] Dynamic subtest pipe-C: SKIP (0.038s)
[81.583990] Starting dynamic subtest: pipe-D
[81.617766] Dynamic subtest pipe-D: SKIP (0.041s)
[81.621519] Subtest planes-unity-scaling-downscale-factor-0-5: SKIP (0.140s)
[81.728882] [009/133] (938s left) kms_plane_scaling (plane-scaler-unity-scaling-with-rotation)
[81.815462] Starting subtest: plane-scaler-unity-scaling-with-rotation
[81.817792] Starting dynamic subtest: pipe-A
[82.042765] Dynamic subtest pipe-A: SUCCESS (0.229s)
[82.051095] Starting dynamic subtest: pipe-B
[83.348174] Dynamic subtest pipe-B: SUCCESS (1.304s)
[83.355682] Starting dynamic subtest: pipe-C
[84.667262] Dynamic subtest pipe-C: SUCCESS (1.318s)
[84.676493] Starting dynamic subtest: pipe-D
[86.002928] Dynamic subtest pipe-D: SUCCESS (1.335s)
[86.005293] Subtest plane-scaler-unity-scaling-with-rotation: SUCCESS (4.189s)
[87.187989] [010/133] (933s left) kms_hdr (static-toggle-suspend)
[87.285246] Starting subtest: static-toggle-suspend
[87.291808] Subtest static-toggle-suspend: SKIP (0.000s)
[87.357148] [011/133] (933s left) core_auth (basic-auth)
[87.406732] Starting subtest: basic-auth
[87.408926] Subtest basic-auth: SUCCESS (0.001s)
[87.500819] [012/133] (932s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[87.611912] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu
[91.914715] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (4.306s)
[93.089544] [013/133] (927s left) gem_exec_balancer (full-late)
[93.145539] Starting subtest: full-late
[97.792482] Subtest full-late: SUCCESS (4.648s)
[98.108823] [014/133] (922s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset)
[98.199066] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset
[98.201449] Starting dynamic subtest: A-eDP1
[101.811626] Dynamic subtest A-eDP1: SUCCESS (3.612s)
[101.821334] Starting dynamic subtest: B-eDP1
[105.011689] Dynamic subtest B-eDP1: SUCCESS (3.200s)
[105.019391] Starting dynamic subtest: C-eDP1
[108.132419] Dynamic subtest C-eDP1: SUCCESS (3.120s)
[108.142269] Starting dynamic subtest: D-eDP1
[111.237656] Dynamic subtest D-eDP1: SUCCESS (3.103s)
[111.240045] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (13.040s)
[112.037838] [015/133] (908s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[112.109908] Starting subtest: map-fixed-invalidate-overlap
[112.114144] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[112.241819] [016/133] (908s left) kms_chamelium_edid (dp-edid-stress-resolution-non-4k)
[112.629292] Subtest dp-edid-stress-resolution-non-4k: SKIP (0.000s)
[113.449761] [017/133] (907s left) gem_exec_reloc (basic-gtt-read-noreloc)
[113.509800] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[113.561224] [018/133] (907s left) syncobj_timeline (transfer-timeline-point)
[113.615131] Starting subtest: transfer-timeline-point
[113.617612] Subtest transfer-timeline-point: SUCCESS (0.001s)
[113.709536] [019/133] (907s left) kms_psr (fbc-psr2-sprite-render)
[113.796384] Starting subtest: fbc-psr2-sprite-render
[113.798678] Starting dynamic subtest: eDP-1
[113.802975] Dynamic subtest eDP-1: SKIP (0.000s)
[113.807111] Subtest fbc-psr2-sprite-render: SKIP (0.002s)
[113.882873] [020/133] (906s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling)
[113.974280] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-downscaling
[113.976637] Starting dynamic subtest: pipe-A-default-mode
[115.121336] Dynamic subtest pipe-A-default-mode: SKIP (1.144s)
[115.125668] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SKIP (1.145s)
[115.240698] [021/133] (905s left) gem_exec_fence (syncobj-repeat)
[115.682067] Starting subtest: syncobj-repeat
[115.870930] Subtest syncobj-repeat: SUCCESS (0.187s)
[116.950408] [FACT gem_exec_fence (syncobj-repeat)] new: kernel.kmod_is_loaded.vgem: true
[116.953736] [022/133] (903s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[117.050678] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[117.054735] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[117.148670] [023/133] (903s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[117.265550] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[117.269967] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[117.422025] [024/133] (903s left) kms_prop_blob (invalid-set-prop)
[117.481083] Starting subtest: invalid-set-prop
[117.482943] Subtest invalid-set-prop: SUCCESS (0.000s)
[117.573418] [025/133] (903s left) kms_atomic_transition (plane-all-transition-nonblocking)
[117.655739] Starting subtest: plane-all-transition-nonblocking
[117.658093] Starting dynamic subtest: pipe-A-eDP-1
[120.149333] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.495s)
[120.467066] Starting dynamic subtest: pipe-B-eDP-1
[123.715215] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.258s)
[124.015906] Subtest plane-all-transition-nonblocking: SUCCESS (6.359s)
[124.862684] [026/133] (896s left) i915_drm_fdinfo (busy-check-all)
[124.911179] Starting subtest: busy-check-all
[124.913497] Starting dynamic subtest: rcs0
[124.918186] Dynamic subtest rcs0: SKIP (0.006s)
[124.926340] Starting dynamic subtest: bcs0
[124.930745] Dynamic subtest bcs0: SKIP (0.000s)
[124.938585] Starting dynamic subtest: vcs0
[124.942698] Dynamic subtest vcs0: SKIP (0.000s)
[124.950442] Starting dynamic subtest: vcs1
[124.954843] Dynamic subtest vcs1: SKIP (0.000s)
[124.962268] Starting dynamic subtest: vecs0
[124.966645] Dynamic subtest vecs0: SKIP (0.000s)
[124.974078] Starting dynamic subtest: ccs0
[124.978282] Dynamic subtest ccs0: SKIP (0.000s)
[124.982681] Subtest busy-check-all: SKIP (0.011s)
[125.018980] [027/133] (896s left) kms_psr (psr-sprite-render)
[125.130067] Starting subtest: psr-sprite-render
[125.132432] Starting dynamic subtest: eDP-1
[126.890048] Dynamic subtest eDP-1: SUCCESS (1.761s)
[126.892473] Subtest psr-sprite-render: SUCCESS (1.762s)
[127.713603] [028/133] (893s left) gem_lmem_swapping (parallel-random)
[127.765688] Subtest parallel-random: SKIP (0.000s)
[127.812197] [029/133] (893s left) gem_workarounds (basic-read)
[127.884970] Starting subtest: basic-read
[127.899598] Subtest basic-read: SUCCESS (0.015s)
[128.012081] [030/133] (893s left) i915_pm_rpm (gem-execbuf-stress-pc8)
[130.050226] Starting subtest: gem-execbuf-stress-pc8
[130.089663] Subtest gem-execbuf-stress-pc8: SKIP (0.041s)
[130.454821] [031/133] (890s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-onoff)
[130.565095] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-onoff
[130.569328] Subtest fbcpsr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[130.661289] [032/133] (890s left) kms_joiner (invalid-modeset-ultra-joiner)
[130.767305] Starting subtest: invalid-modeset-ultra-joiner
[130.771460] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s)
[130.835184] [033/133] (890s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[130.931062] Starting subtest: 4-tiled-16bpp-rotate-90
[130.951582] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.020s)
[131.056955] [034/133] (890s left) kms_vblank (query-forked-hang)
[131.147369] Starting subtest: query-forked-hang
[131.149599] Starting dynamic subtest: pipe-A-eDP-1
[157.652780] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.504s)
[157.666953] Starting dynamic subtest: pipe-D-eDP-1
[182.745183] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.091s)
[182.747469] Subtest query-forked-hang: SUCCESS (51.599s)
[183.596255] [035/133] (837s left) gem_exec_fence (expired-history)
[184.016759] Starting subtest: expired-history
[191.560377] Subtest expired-history: SUCCESS (7.543s)
[192.253836] [036/133] (829s left) gem_render_copy (x-tiled)
[192.311829] Starting subtest: x-tiled
[192.314074] Starting dynamic subtest: smem
[192.361937] Dynamic subtest smem: SUCCESS (0.050s)
[192.364703] Subtest x-tiled: SUCCESS (0.050s)
[192.582914] [037/133] (828s left) gem_mmap_gtt (isolation)
[192.649936] Subtest isolation: SKIP (0.000s)
[192.728207] [038/133] (828s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[192.822596] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[192.826844] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[192.915120] [039/133] (828s left) kms_cursor_legacy (cursorb-vs-flipb-legacy)
[193.030099] Starting subtest: cursorB-vs-flipB-legacy
[193.034393] Subtest cursorB-vs-flipB-legacy: SKIP (0.001s)
[193.177124] [040/133] (828s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions)
[193.287245] Starting subtest: cursorB-vs-flipA-atomic-transitions
[193.291602] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.001s)
[193.442502] [041/133] (828s left) gem_create (hog-create)
[193.505221] Starting subtest: hog-create
[193.507087] Starting dynamic subtest: smem0
[226.905307] Dynamic subtest smem0: SUCCESS (33.397s)
[226.908034] Subtest hog-create: SUCCESS (33.398s)
[227.096310] [042/133] (794s left) gem_exec_schedule (semaphore-user)
[227.173171] Starting subtest: semaphore-user
[227.229823] Subtest semaphore-user: SUCCESS (0.063s)
[228.941350] [043/133] (792s left) kms_psr (psr2-primary-render)
[229.027818] Starting subtest: psr2-primary-render
[229.030291] Starting dynamic subtest: eDP-1
[230.777029] Dynamic subtest eDP-1: SUCCESS (1.750s)
[230.779413] Subtest psr2-primary-render: SUCCESS (1.750s)
[231.653723] [044/133] (790s left) kms_async_flips (async-flip-dpms)
[231.751176] Starting subtest: async-flip-dpms
[232.122053] Starting dynamic subtest: pipe-A-eDP-1
[235.957910] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.835s)
[236.350155] Starting dynamic subtest: pipe-B-eDP-1
[239.153559] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.811s)
[239.536077] Starting dynamic subtest: pipe-C-eDP-1
[242.317642] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.788s)
[242.709378] Starting dynamic subtest: pipe-D-eDP-1
[245.501946] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.800s)
[245.504236] Subtest async-flip-dpms: SUCCESS (13.752s)
[246.678227] [045/133] (775s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[246.733374] Starting subtest: etime-multi-wait-all-submitted-signaled
[246.842502] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.109s)
[246.918219] [046/133] (775s left) i915_selftest (mock)
[248.638835] Starting subtest: mock
[248.641271] Starting dynamic subtest: sanitycheck
[249.296234] Dynamic subtest sanitycheck: SUCCESS (0.658s)
[249.305732] Starting dynamic subtest: shmem
[249.988174] Dynamic subtest shmem: SUCCESS (0.690s)
[249.998378] Starting dynamic subtest: fence
[258.002723] Dynamic subtest fence: SUCCESS (8.012s)
[258.011763] Starting dynamic subtest: scatterlist
[259.687271] Dynamic subtest scatterlist: SUCCESS (1.683s)
[259.696314] Starting dynamic subtest: syncmap
[262.926198] Dynamic subtest syncmap: SUCCESS (3.237s)
[262.933982] Starting dynamic subtest: uncore
[263.590352] Dynamic subtest uncore: SUCCESS (0.663s)
[263.599603] Starting dynamic subtest: ring
[264.246252] Dynamic subtest ring: SUCCESS (0.654s)
[264.255803] Starting dynamic subtest: engine
[264.935249] Dynamic subtest engine: SUCCESS (0.687s)
[264.942662] Starting dynamic subtest: timelines
[268.767997] Dynamic subtest timelines: SUCCESS (3.830s)
[268.777598] Starting dynamic subtest: requests
[272.453641] Dynamic subtest requests: SUCCESS (3.685s)
[272.462956] Starting dynamic subtest: objects
[273.229264] Dynamic subtest objects: SUCCESS (0.775s)
[273.238830] Starting dynamic subtest: phys
[273.981042] Dynamic subtest phys: SUCCESS (0.751s)
[273.990235] Starting dynamic subtest: dmabuf
[274.739142] Dynamic subtest dmabuf: SUCCESS (0.757s)
[274.748527] Starting dynamic subtest: vma
[280.627608] Dynamic subtest vma: SUCCESS (5.886s)
[280.636788] Starting dynamic subtest: evict
[282.016315] Dynamic subtest evict: SUCCESS (1.387s)
[282.026129] Starting dynamic subtest: gtt
[285.334078] Dynamic subtest gtt: SUCCESS (3.317s)
[285.343298] Starting dynamic subtest: hugepages
[286.235633] Dynamic subtest hugepages: SUCCESS (0.901s)
[286.244997] Starting dynamic subtest: memory_region
[288.802232] Dynamic subtest memory_region: SUCCESS (2.564s)
[288.805180] Subtest mock: SUCCESS (40.163s)
[288.832853] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[288.833608] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[288.837257] [047/133] (733s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc)
[290.359142] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc
[290.361379] Starting dynamic subtest: pipe-A-eDP-1
[290.418487] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[290.427810] Starting dynamic subtest: pipe-B-eDP-1
[290.483879] Dynamic subtest pipe-B-eDP-1: SKIP (0.002s)
[290.493116] Starting dynamic subtest: pipe-C-eDP-1
[290.549980] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[290.559199] Starting dynamic subtest: pipe-D-eDP-1
[290.617271] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[290.621815] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.011s)
[292.722188] [FACT kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[292.723455] [FACT kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc)] new: kernel.kmod_is_loaded.i915: true
[292.727748] [048/133] (729s left) kms_psr (fbc-psr2-cursor-blt)
[292.828124] Starting subtest: fbc-psr2-cursor-blt
[292.830314] Starting dynamic subtest: eDP-1
[292.834195] Dynamic subtest eDP-1: SKIP (0.000s)
[292.838139] Subtest fbc-psr2-cursor-blt: SKIP (0.001s)
[292.913503] [049/133] (729s left) gem_exec_store (cachelines)
[292.981224] Starting subtest: cachelines
[292.983475] Starting dynamic subtest: rcs0
[293.069865] Dynamic subtest rcs0: SUCCESS (0.089s)
[293.080705] Starting dynamic subtest: bcs0
[293.125461] Dynamic subtest bcs0: SUCCESS (0.054s)
[293.135115] Starting dynamic subtest: vcs0
[293.189116] Dynamic subtest vcs0: SUCCESS (0.061s)
[293.199078] Starting dynamic subtest: vcs1
[293.246059] Dynamic subtest vcs1: SUCCESS (0.055s)
[293.258276] Starting dynamic subtest: vecs0
[293.309271] Dynamic subtest vecs0: SUCCESS (0.060s)
[293.319496] Starting dynamic subtest: ccs0
[293.361345] Dynamic subtest ccs0: SUCCESS (0.050s)
[293.363716] Subtest cachelines: SUCCESS (0.382s)
[293.548918] [050/133] (728s left) gem_wait (busy)
[293.610328] Starting subtest: busy
[293.612731] Starting dynamic subtest: all-engines
[294.936466] Dynamic subtest all-engines: SUCCESS (1.323s)
[294.948414] Starting dynamic subtest: rcs0
[295.479226] Dynamic subtest rcs0: SUCCESS (0.542s)
[295.489911] Starting dynamic subtest: bcs0
[296.019958] Dynamic subtest bcs0: SUCCESS (0.539s)
[296.030881] Starting dynamic subtest: vcs0
[297.941519] Dynamic subtest vcs0: SUCCESS (1.919s)
[297.951871] Starting dynamic subtest: vcs1
[299.925525] Dynamic subtest vcs1: SUCCESS (1.982s)
[299.936498] Starting dynamic subtest: vecs0
[301.909460] Dynamic subtest vecs0: SUCCESS (1.981s)
[301.920669] Starting dynamic subtest: ccs0
[302.450091] Dynamic subtest ccs0: SUCCESS (0.540s)
[302.452556] Subtest busy: SUCCESS (8.839s)
[302.666185] [051/133] (719s left) vgem_basic (dmabuf-export)
[302.728635] Starting subtest: dmabuf-export
[302.744872] Subtest dmabuf-export: SUCCESS (0.015s)
[302.842676] [052/133] (719s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier-source-clamping)
[302.945020] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier-source-clamping
[302.949357] Subtest pixel-format-4-tiled-lnl-ccs-modifier-source-clamping: SKIP (0.000s)
[303.023185] [053/133] (719s left) kms_color (legacy-gamma-reset)
[303.131179] Starting subtest: legacy-gamma-reset
[303.133496] Starting dynamic subtest: pipe-A-eDP-1
[303.509473] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.379s)
[303.518110] Starting dynamic subtest: pipe-B-eDP-1
[303.522995] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.012s)
[303.530581] Starting dynamic subtest: pipe-C-eDP-1
[303.536782] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.014s)
[303.544268] Starting dynamic subtest: pipe-D-eDP-1
[303.549589] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.012s)
[303.551897] Subtest legacy-gamma-reset: SUCCESS (0.420s)
[304.306638] [054/133] (717s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[304.414115] Starting subtest: psr-rgb101010-draw-mmap-gtt
[304.418227] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[304.497778] [055/133] (717s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf)
[304.596041] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf
[304.598393] Starting dynamic subtest: pipe-A-eDP-1
[304.692652] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[304.702119] Starting dynamic subtest: pipe-B-eDP-1
[305.881265] Dynamic subtest pipe-B-eDP-1: SKIP (1.186s)
[305.886027] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.289s)
[307.070882] [056/133] (715s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[307.178823] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip
[308.201395] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (1.022s)
[308.335162] [057/133] (714s left) kms_flip (2x-flip-vs-blocking-wf-vblank)
[308.427070] Starting subtest: 2x-flip-vs-blocking-wf-vblank
[308.435695] Subtest 2x-flip-vs-blocking-wf-vblank: SKIP (0.011s)
[308.512615] [058/133] (713s left) gem_exec_params (invalid-bsd1-flag-on-blt)
[308.584059] Starting subtest: invalid-bsd1-flag-on-blt
[308.585668] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s)
[308.685607] [059/133] (713s left) gem_ringfill (basic-all)
[313.881071] Starting subtest: basic-all
[315.039253] Subtest basic-all: SUCCESS (1.158s)
[315.175580] [060/133] (707s left) kms_cursor_legacy (cursorb-vs-flipa-atomic)
[315.310066] Starting subtest: cursorB-vs-flipA-atomic
[315.314335] Subtest cursorB-vs-flipA-atomic: SKIP (0.001s)
[315.456464] [061/133] (707s left) kms_pm_rpm (universal-planes-dpms)
[317.089548] Starting subtest: universal-planes-dpms
[317.091975] Starting dynamic subtest: plane-35
[325.374224] Dynamic subtest plane-35: SUCCESS (8.287s)
[325.385877] Starting dynamic subtest: plane-65
[333.682067] Dynamic subtest plane-65: SUCCESS (8.304s)
[333.693771] Starting dynamic subtest: plane-95
[342.113225] Dynamic subtest plane-95: SUCCESS (8.428s)
[342.127715] Starting dynamic subtest: plane-125
[350.429546] Dynamic subtest plane-125: SUCCESS (8.313s)
[350.440814] Starting dynamic subtest: plane-135
[358.745356] Dynamic subtest plane-135: SUCCESS (8.313s)
[358.757277] Starting dynamic subtest: plane-145
[367.064989] Dynamic subtest plane-145: SUCCESS (8.317s)
[367.067604] Subtest universal-planes-dpms: SUCCESS (49.980s)
[367.458641] [062/133] (655s left) gem_ctx_param (invalid-param-set)
[367.513912] Starting subtest: invalid-param-set
[367.516283] Subtest invalid-param-set: SUCCESS (0.000s)
[367.606710] [063/133] (655s left) gem_exec_alignment (pi)
[367.677674] Starting subtest: pi
[421.367749] Subtest pi: SUCCESS (53.684s)
[422.328446] [064/133] (600s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move)
[422.487595] Starting subtest: psr-1p-primscrn-spr-indfb-move
[430.072281] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (7.588s)
[430.230747] [065/133] (592s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[430.610352] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[431.382033] [066/133] (591s left) gen7_exec_parse (oacontrol-tracking)
[431.443303] Subtest oacontrol-tracking: SKIP (0.000s)
[431.507414] [067/133] (591s left) gem_userptr_blits (unsync-unmap-cycles)
[431.572977] Subtest unsync-unmap-cycles: SKIP (0.000s)
[431.701036] [068/133] (591s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)
[431.787561] Starting subtest: psr-2p-primscrn-spr-indfb-move
[431.791848] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[431.908692] [069/133] (590s left) kms_addfb_basic (too-high)
[431.995994] Starting subtest: too-high
[431.998201] Subtest too-high: SUCCESS (0.001s)
[432.103166] [070/133] (590s left) kms_addfb_basic (bad-pitch-1024)
[432.169839] Starting subtest: bad-pitch-1024
[432.172258] Subtest bad-pitch-1024: SUCCESS (0.000s)
[432.310479] [071/133] (590s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[432.414497] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[432.418496] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[432.516508] [072/133] (590s left) prime_mmap (test_invalid_sync_flags)
[432.583452] Starting subtest: test_invalid_sync_flags
[432.585627] Starting dynamic subtest: test_invalid_sync_flags-smem
[432.587633] Dynamic subtest test_invalid_sync_flags-smem: SUCCESS (0.000s)
[432.589559] Subtest test_invalid_sync_flags: SUCCESS (0.001s)
[432.701417] [073/133] (590s left) perf (non-zero-reason)
[432.852990] Starting subtest: non-zero-reason
[432.854830] Starting dynamic subtest: 0-rcs0
[438.357309] Dynamic subtest 0-rcs0: SUCCESS (5.450s)
[438.368853] Starting dynamic subtest: 1-vcs0
[442.249443] Dynamic subtest 1-vcs0: SUCCESS (3.944s)
[442.252486] Subtest non-zero-reason: SUCCESS (9.396s)
[442.300746] [074/133] (580s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[442.398122] Starting subtest: y-tiled-32bpp-rotate-0
[442.402670] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[442.487947] [075/133] (580s left) kms_frontbuffer_tracking (basic)
[442.579409] Starting subtest: basic
[445.946482] Subtest basic: SUCCESS (3.371s)
[446.063410] [076/133] (577s left) gem_ppgtt (shrink-vs-evict-any)
[446.124094] Starting subtest: shrink-vs-evict-any
[451.938255] Subtest shrink-vs-evict-any: SUCCESS (5.760s)
[451.979653] [077/133] (571s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[452.081953] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[452.906306] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.826s)
[453.070465] [078/133] (570s left) gem_ctx_persistence (legacy-engines-cleanup)
[453.148880] Starting subtest: legacy-engines-cleanup
[453.151705] Starting dynamic subtest: render
[453.219745] Dynamic subtest render: SUCCESS (0.069s)
[453.230408] Starting dynamic subtest: bsd1
[453.261517] Dynamic subtest bsd1: SUCCESS (0.039s)
[453.276577] Starting dynamic subtest: bsd2
[453.301365] Dynamic subtest bsd2: SUCCESS (0.036s)
[453.314825] Starting dynamic subtest: blt
[453.347639] Dynamic subtest blt: SUCCESS (0.044s)
[453.365958] Starting dynamic subtest: vebox
[453.376555] Dynamic subtest vebox: SUCCESS (0.026s)
[453.378880] Subtest legacy-engines-cleanup: SUCCESS (0.228s)
[453.505798] [079/133] (569s left) kms_big_fb (x-tiled-8bpp-rotate-270)
[453.608026] Starting subtest: x-tiled-8bpp-rotate-270
[453.629203] Subtest x-tiled-8bpp-rotate-270: SKIP (0.020s)
[453.745834] [080/133] (569s left) dmabuf_sync_file (export-wait-after-attach)
[453.798100] Starting subtest: export-wait-after-attach
[453.799795] Subtest export-wait-after-attach: SUCCESS (0.001s)
[453.851815] [081/133] (569s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[453.945526] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[462.509832] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.562s)
[462.620154] [082/133] (560s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt)
[462.730863] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt
[469.598110] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.870s)
[469.737747] [083/133] (553s left) vgem_basic (dmabuf-fence-before)
[469.786057] Starting subtest: dmabuf-fence-before
[469.788494] Subtest dmabuf-fence-before: SUCCESS (0.001s)
[469.845535] [084/133] (553s left) kms_cursor_edge_walk (256x256-top-bottom)
[469.945624] Starting subtest: 256x256-top-bottom
[469.948268] Starting dynamic subtest: pipe-A-eDP-1
[473.371339] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.428s)
[473.381092] Starting dynamic subtest: pipe-D-eDP-1
[476.484751] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.111s)
[476.487063] Subtest 256x256-top-bottom: SUCCESS (6.542s)
[477.289664] [085/133] (546s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[477.388329] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[484.788724] Subtest psr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.403s)
[484.930071] [086/133] (538s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[485.034431] Starting subtest: psr2-plane-move-sf-dmg-area
[485.036577] Starting dynamic subtest: pipe-A-eDP-1
[489.584501] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.555s)
[489.595039] Starting dynamic subtest: pipe-B-eDP-1
[494.917745] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.330s)
[494.920134] Subtest psr2-plane-move-sf-dmg-area: SUCCESS (9.888s)
[495.779957] [087/133] (527s left) syncobj_timeline (multi-wait-for-submit-available-signaled)
[495.842873] Starting subtest: multi-wait-for-submit-available-signaled
[495.845327] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.000s)
[495.957377] [088/133] (527s left) kms_ccs (bad-aux-stride-yf-tiled-ccs)
[496.064085] Starting subtest: bad-aux-stride-yf-tiled-ccs
[496.066342] Starting dynamic subtest: pipe-A-eDP-1
[496.089128] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[496.099460] Starting dynamic subtest: pipe-B-eDP-1
[496.120966] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[496.129647] Starting dynamic subtest: pipe-C-eDP-1
[496.151900] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[496.160362] Starting dynamic subtest: pipe-D-eDP-1
[496.182165] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[496.186472] Subtest bad-aux-stride-yf-tiled-ccs: SKIP (0.005s)
[498.349848] [089/133] (525s left) gem_partial_pwrite_pread (writes-after-reads)
[498.410436] Subtest writes-after-reads: SKIP (0.000s)
[498.484550] [090/133] (525s left) syncobj_wait (invalid-wait-bad-flags)
[498.544052] Starting subtest: invalid-wait-bad-flags
[498.546238] Subtest invalid-wait-bad-flags: SUCCESS (0.000s)
[498.637170] [091/133] (525s left) gem_exec_reloc (basic-write-wc-active)
[498.714101] Subtest basic-write-wc-active: SKIP (0.000s)
[498.785440] [092/133] (525s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-blt)
[498.872851] Starting subtest: psr-2p-primscrn-pri-indfb-draw-blt
[498.877655] Subtest psr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[498.955455] [093/133] (524s left) fbdev (write)
[498.997515] Starting subtest: write
[499.357446] Subtest write: SUCCESS (0.361s)
[499.420109] [094/133] (524s left) api_intel_bb (simple-bb-ctx)
[499.485397] Starting subtest: simple-bb-ctx
[499.492360] Subtest simple-bb-ctx: SUCCESS (0.008s)
[499.618788] [095/133] (524s left) gem_workarounds (basic-read-fd)
[499.686285] Starting subtest: basic-read-fd
[499.698255] Subtest basic-read-fd: SUCCESS (0.012s)
[499.834991] [096/133] (524s left) kms_busy (extended-modeset-hang-oldfb-with-reset)
[499.936585] Starting subtest: extended-modeset-hang-oldfb-with-reset
[499.939240] Starting dynamic subtest: pipe-A
[511.432825] Dynamic subtest pipe-A: SUCCESS (11.493s)
[511.444058] Starting dynamic subtest: pipe-D
[523.724757] Dynamic subtest pipe-D: SUCCESS (12.289s)
[523.727149] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (23.787s)
[524.512041] [097/133] (499s left) gem_exec_params (no-blt)
[524.566599] Starting subtest: no-blt
[524.571281] Subtest no-blt: SUCCESS (0.003s)
[524.676321] [098/133] (499s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled-ccs)
[524.733544] Starting subtest: yf-tiled-ccs-to-yf-tiled-ccs
[524.738184] Subtest yf-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[524.918922] [099/133] (499s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[525.013289] Starting subtest: read-crc-frame-sequence
[525.015198] Starting dynamic subtest: pipe-A-eDP-1
[525.732647] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.717s)
[525.742948] Starting dynamic subtest: pipe-B-eDP-1
[527.087799] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.356s)
[527.097930] Starting dynamic subtest: pipe-C-eDP-1
[528.390193] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.300s)
[528.400482] Starting dynamic subtest: pipe-D-eDP-1
[529.714365] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.325s)
[529.716785] Subtest read-crc-frame-sequence: SUCCESS (4.704s)
[530.547274] [100/133] (493s left) gem_ctx_param (invalid-set-ringsize)
[530.593737] Starting subtest: invalid-set-ringsize
[530.596058] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[530.671833] [101/133] (493s left) gem_softpin (noreloc)
[530.726729] Starting subtest: noreloc
[536.172276] Subtest noreloc: SUCCESS (5.391s)
[536.251099] [102/133] (488s left) kms_cursor_crc (cursor-offscreen-256x85)
[536.535101] Starting subtest: cursor-offscreen-256x85
[536.581262] Subtest cursor-offscreen-256x85: SKIP (0.045s)
[536.775364] [103/133] (487s left) gem_exec_fence (syncobj-timeline-wait)
[537.363919] Starting subtest: syncobj-timeline-wait
[538.934954] Subtest syncobj-timeline-wait: SUCCESS (1.572s)
[540.937472] [104/133] (483s left) kms_explicit_fence (multiplane-atomic-fence-wait)
[541.091702] Starting subtest: multiplane-atomic-fence-wait
[541.408138] Subtest multiplane-atomic-fence-wait: SUCCESS (0.317s)
[542.573632] [105/133] (481s left) gem_exec_params (dr4-dirt)
[542.630823] Starting subtest: DR4-dirt
[542.633099] Subtest DR4-dirt: SUCCESS (0.000s)
[542.728867] [106/133] (481s left) kms_pwrite_crc
[544.310245] [107/133] (480s left) kms_cdclk (plane-scaling)
[544.397782] Starting subtest: plane-scaling
[544.400015] Starting dynamic subtest: pipe-A-eDP-1
[544.691407] Dynamic subtest pipe-A-eDP-1: SKIP (0.292s)
[544.701042] Starting dynamic subtest: pipe-B-eDP-1
[544.705276] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[544.714152] Starting dynamic subtest: pipe-C-eDP-1
[544.718392] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[544.727507] Starting dynamic subtest: pipe-D-eDP-1
[544.731954] Dynamic subtest pipe-D-eDP-1: SKIP (0.004s)
[544.735962] Subtest plane-scaling: SKIP (0.303s)
[545.533976] [108/133] (479s left) syncobj_timeline (invalid-transfer-illegal-handle)
[545.592276] Starting subtest: invalid-transfer-illegal-handle
[545.594546] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s)
[545.682862] [109/133] (478s left) kms_content_protection (dp-mst-type-0)
[545.833378] Starting subtest: dp-mst-type-0
[545.837905] Subtest dp-mst-type-0: SKIP (0.000s)
[545.956979] [110/133] (478s left) sw_sync (alloc_merge_fence)
[545.996121] Starting subtest: alloc_merge_fence
[545.998448] Subtest alloc_merge_fence: SUCCESS (0.000s)
[546.060988] [111/133] (478s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[546.160023] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[546.164597] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[546.265803] [112/133] (478s left) kms_cursor_crc (cursor-random-128x128)
[546.490520] Starting subtest: cursor-random-128x128
[546.494629] Starting dynamic subtest: pipe-A-eDP-1
[549.855938] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.359s)
[549.888228] Starting dynamic subtest: pipe-D-eDP-1
[553.876828] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.994s)
[553.879491] Subtest cursor-random-128x128: SUCCESS (7.384s)
[554.705303] [113/133] (470s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-upscaling)
[554.808087] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-upscaling
[554.812280] Subtest flip-64bpp-ytile-to-16bpp-ytile-upscaling: SKIP (0.000s)
[554.883706] [114/133] (469s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-plflip-blt)
[554.992391] Starting subtest: fbc-2p-scndscrn-shrfb-plflip-blt
[554.996653] Subtest fbc-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[555.097059] [115/133] (469s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[555.195230] Starting subtest: 4-tiled-16bpp-rotate-0
[556.473580] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.279s)
[556.598304] [116/133] (468s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-pwrite)
[556.690044] Starting subtest: psr-1p-offscreen-pri-indfb-draw-pwrite
[563.862633] Subtest psr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.172s)
[563.978621] [117/133] (460s left) kms_universal_plane (universal-plane-sanity)
[564.083643] Starting subtest: universal-plane-sanity
[564.085639] Starting dynamic subtest: pipe-A-eDP-1
[564.717073] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.633s)
[564.727057] Starting dynamic subtest: pipe-B-eDP-1
[565.997668] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.280s)
[566.007570] Starting dynamic subtest: pipe-C-eDP-1
[567.221456] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.219s)
[567.230961] Starting dynamic subtest: pipe-D-eDP-1
[568.453579] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.231s)
[568.455580] Subtest universal-plane-sanity: SUCCESS (4.370s)
[569.308104] [118/133] (455s left) kms_frontbuffer_tracking (fbc-shrfb-scaledprimary)
[569.403848] Starting subtest: fbc-shrfb-scaledprimary
[572.457193] Subtest fbc-shrfb-scaledprimary: SUCCESS (3.057s)
[573.614454] [119/133] (451s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping)
[573.707243] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping
[573.711639] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[573.781392] [120/133] (451s left) gem_mmap_gtt (cpuset-medium-copy)
[573.837578] Subtest cpuset-medium-copy: SKIP (0.000s)
[573.900126] [121/133] (451s left) kms_pm_backlight (fade-with-suspend)
[573.997929] Starting subtest: fade-with-suspend
[589.733153] Starting dynamic subtest: eDP-1
[592.208503] Dynamic subtest eDP-1: SUCCESS (2.475s)
[592.211080] Subtest fade-with-suspend: SUCCESS (4.540s)
[593.053935] [122/133] (432s left) api_intel_bb (blit-reloc-purge-cache)
[593.125268] Starting subtest: blit-reloc-purge-cache
[593.129713] Subtest blit-reloc-purge-cache: SKIP (0.000s)
[593.260492] [123/133] (431s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-mc-ccs)
[593.355623] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-mc-ccs
[593.357994] Starting dynamic subtest: pipe-A-eDP-1
[593.381207] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[593.395293] Starting dynamic subtest: pipe-B-eDP-1
[593.416800] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[593.426332] Starting dynamic subtest: pipe-C-eDP-1
[593.448072] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[593.457563] Starting dynamic subtest: pipe-D-eDP-1
[593.479326] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[593.483676] Subtest crc-primary-rotation-180-4-tiled-dg2-mc-ccs: SKIP (0.006s)
[595.614628] [124/133] (429s left) kms_big_fb (yf-tiled-addfb)
[595.716486] Starting subtest: yf-tiled-addfb
[595.720836] Subtest yf-tiled-addfb: SKIP (0.000s)
[595.810653] [125/133] (429s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-blt)
[595.907108] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-blt
[595.911313] Subtest fbc-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[596.002714] [126/133] (429s left) sysfs_heartbeat_interval (nopreempt)
[596.067949] Starting subtest: nopreempt
[596.070409] Starting dynamic subtest: vecs0
[605.557928] Dynamic subtest vecs0: SUCCESS (9.478s)
[605.571480] Starting dynamic subtest: ccs0
[609.665768] Dynamic subtest ccs0: SUCCESS (4.105s)
[609.676946] Starting dynamic subtest: vcs0
[619.575124] Dynamic subtest vcs0: SUCCESS (9.902s)
[619.588060] Starting dynamic subtest: bcs0
[623.567530] Dynamic subtest bcs0: SUCCESS (3.991s)
[623.580079] Starting dynamic subtest: rcs0
[627.579780] Dynamic subtest rcs0: SUCCESS (4.010s)
[627.592766] Starting dynamic subtest: vcs1
[637.559940] Dynamic subtest vcs1: SUCCESS (9.973s)
[637.562689] Subtest nopreempt: SUCCESS (41.471s)
[637.638779] [127/133] (387s left) i915_module_load (reload-no-display)
[637.680945] Starting subtest: reload-no-display
[643.664557] Subtest reload-no-display: SUCCESS (5.982s)
[643.697723] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[643.698607] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[643.702377] [128/133] (381s left) kms_flip (flip-vs-dpms-off-vs-modeset-interruptible)
[645.304419] Starting subtest: flip-vs-dpms-off-vs-modeset-interruptible
[645.306621] Starting dynamic subtest: A-eDP1
[648.848059] Dynamic subtest A-eDP1: SUCCESS (3.538s)
[648.857682] Starting dynamic subtest: B-eDP1
[652.039086] Dynamic subtest B-eDP1: SUCCESS (3.189s)
[652.049089] Starting dynamic subtest: C-eDP1
[655.166742] Dynamic subtest C-eDP1: SUCCESS (3.125s)
[655.176905] Starting dynamic subtest: D-eDP1
[658.257050] Dynamic subtest D-eDP1: SUCCESS (3.089s)
[658.259243] Subtest flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (12.950s)
[659.102920] [FACT kms_flip (flip-vs-dpms-off-vs-modeset-interruptible)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[659.104178] [FACT kms_flip (flip-vs-dpms-off-vs-modeset-interruptible)] new: kernel.kmod_is_loaded.i915: true
[659.108114] [129/133] (366s left) syncobj_eventfd (binary-wait)
[659.170468] Starting subtest: binary-wait
[659.179517] Subtest binary-wait: SUCCESS (0.010s)
[659.256419] [130/133] (366s left) kms_psr (pr-sprite-mmap-gtt)
[659.350174] Starting subtest: pr-sprite-mmap-gtt
[659.354624] Subtest pr-sprite-mmap-gtt: SKIP (0.000s)
[659.425860] [131/133] (366s left) prime_busy (hang)
[659.480096] Starting subtest: hang
[659.482535] Starting dynamic subtest: rcs0
[686.110800] Dynamic subtest rcs0: SUCCESS (26.616s)
[686.119718] Starting dynamic subtest: bcs0
[693.264882] Dynamic subtest bcs0: SUCCESS (7.151s)
[693.273893] Starting dynamic subtest: vcs0
[700.226692] Dynamic subtest vcs0: SUCCESS (6.973s)
[700.235956] Starting dynamic subtest: vcs1
[707.200549] Dynamic subtest vcs1: SUCCESS (6.974s)
[707.212495] Starting dynamic subtest: vecs0
[714.243531] Dynamic subtest vecs0: SUCCESS (7.039s)
[714.252605] Starting dynamic subtest: ccs0
[728.079523] Dynamic subtest ccs0: SUCCESS (13.837s)
[728.082166] Subtest hang: SUCCESS (68.599s)
[728.193922] [132/133] (297s left) gem_exec_reloc (basic-write-cpu)
[728.273516] Subtest basic-write-cpu: SKIP (0.000s)
[728.354530] [133/133] (297s left) gem_exec_schedule (preemptive-hang)
[728.536122] Starting subtest: preemptive-hang
[728.538824] Starting dynamic subtest: rcs0
[737.701016] Dynamic subtest rcs0: SUCCESS (9.160s)
[737.712435] Starting dynamic subtest: bcs0
[746.727510] Dynamic subtest bcs0: SUCCESS (9.024s)
[746.739225] Starting dynamic subtest: vcs0
[755.749875] Dynamic subtest vcs0: SUCCESS (9.019s)
[755.761089] Starting dynamic subtest: vcs1
[764.705348] Dynamic subtest vcs1: SUCCESS (8.956s)
[764.717061] Starting dynamic subtest: vecs0
[773.670980] Dynamic subtest vecs0: SUCCESS (8.959s)
[773.680617] Starting dynamic subtest: ccs0
[782.695917] Dynamic subtest ccs0: SUCCESS (9.025s)
[782.698123] Subtest preemptive-hang: SUCCESS (54.151s)
[782.937484] Closing watchdogs
results: parsing output: 0/ for test: kms_ccs
results: parsing output: 1/ for test: perf_pmu
results: parsing output: 2/ for test: kms_pipe_b_c_ivb
results: parsing output: 3/ for test: kms_flip_scaled_crc
results: parsing output: 4/ for test: gem_exec_reloc
results: parsing output: 5/ for test: gem_mmap_gtt
results: parsing output: 6/ for test: gem_softpin
results: parsing output: 7/ for test: kms_plane_scaling
results: parsing output: 8/ for test: kms_plane_scaling
results: parsing output: 9/ for test: kms_hdr
results: parsing output: 10/ for test: core_auth
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: gem_exec_balancer
results: parsing output: 13/ for test: kms_flip
results: parsing output: 14/ for test: gem_userptr_blits
results: parsing output: 15/ for test: kms_chamelium_edid
results: parsing output: 16/ for test: gem_exec_reloc
results: parsing output: 17/ for test: syncobj_timeline
results: parsing output: 18/ for test: kms_psr
results: parsing output: 19/ for test: kms_flip_scaled_crc
results: parsing output: 20/ for test: gem_exec_fence
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: kms_cursor_legacy
results: parsing output: 23/ for test: kms_prop_blob
results: parsing output: 24/ for test: kms_atomic_transition
results: parsing output: 25/ for test: i915_drm_fdinfo
results: parsing output: 26/ for test: kms_psr
results: parsing output: 27/ for test: gem_lmem_swapping
results: parsing output: 28/ for test: gem_workarounds
results: parsing output: 29/ for test: i915_pm_rpm
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_joiner
results: parsing output: 32/ for test: kms_big_fb
results: parsing output: 33/ for test: kms_vblank
results: parsing output: 34/ for test: gem_exec_fence
results: parsing output: 35/ for test: gem_render_copy
results: parsing output: 36/ for test: gem_mmap_gtt
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_cursor_legacy
results: parsing output: 39/ for test: kms_cursor_legacy
results: parsing output: 40/ for test: gem_create
results: parsing output: 41/ for test: gem_exec_schedule
results: parsing output: 42/ for test: kms_psr
results: parsing output: 43/ for test: kms_async_flips
results: parsing output: 44/ for test: syncobj_timeline
results: parsing output: 45/ for test: i915_selftest
results: parsing output: 46/ for test: kms_ccs
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: gem_exec_store
results: parsing output: 49/ for test: gem_wait
results: parsing output: 50/ for test: vgem_basic
results: parsing output: 51/ for test: kms_plane
results: parsing output: 52/ for test: kms_color
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_psr2_sf
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: kms_flip
results: parsing output: 57/ for test: gem_exec_params
results: parsing output: 58/ for test: gem_ringfill
results: parsing output: 59/ for test: kms_cursor_legacy
results: parsing output: 60/ for test: kms_pm_rpm
results: parsing output: 61/ for test: gem_ctx_param
results: parsing output: 62/ for test: gem_exec_alignment
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_chamelium_hpd
results: parsing output: 65/ for test: gen7_exec_parse
results: parsing output: 66/ for test: gem_userptr_blits
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: kms_addfb_basic
results: parsing output: 69/ for test: kms_addfb_basic
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: prime_mmap
results: parsing output: 72/ for test: perf
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: gem_ppgtt
results: parsing output: 76/ for test: kms_big_fb
results: parsing output: 77/ for test: gem_ctx_persistence
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: dmabuf_sync_file
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: vgem_basic
results: parsing output: 83/ for test: kms_cursor_edge_walk
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_psr2_sf
results: parsing output: 86/ for test: syncobj_timeline
results: parsing output: 87/ for test: kms_ccs
results: parsing output: 88/ for test: gem_partial_pwrite_pread
results: parsing output: 89/ for test: syncobj_wait
results: parsing output: 90/ for test: gem_exec_reloc
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: fbdev
results: parsing output: 93/ for test: api_intel_bb
results: parsing output: 94/ for test: gem_workarounds
results: parsing output: 95/ for test: kms_busy
results: parsing output: 96/ for test: gem_exec_params
results: parsing output: 97/ for test: gem_render_copy
results: parsing output: 98/ for test: kms_pipe_crc_basic
results: parsing output: 99/ for test: gem_ctx_param
results: parsing output: 100/ for test: gem_softpin
results: parsing output: 101/ for test: kms_cursor_crc
results: parsing output: 102/ for test: gem_exec_fence
results: parsing output: 103/ for test: kms_explicit_fence
results: parsing output: 104/ for test: gem_exec_params
results: parsing output: 105/ for test: kms_pwrite_crc
results: parsing output: 106/ for test: kms_cdclk
results: parsing output: 107/ for test: syncobj_timeline
results: parsing output: 108/ for test: kms_content_protection
results: parsing output: 109/ for test: sw_sync
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_cursor_crc
results: parsing output: 112/ for test: kms_flip_scaled_crc
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_universal_plane
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_plane
results: parsing output: 119/ for test: gem_mmap_gtt
results: parsing output: 120/ for test: kms_pm_backlight
results: parsing output: 121/ for test: api_intel_bb
results: parsing output: 122/ for test: kms_ccs
results: parsing output: 123/ for test: kms_big_fb
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: sysfs_heartbeat_interval
results: parsing output: 126/ for test: i915_module_load
results: parsing output: 127/ for test: kms_flip
results: parsing output: 128/ for test: syncobj_eventfd
results: parsing output: 129/ for test: kms_psr
results: parsing output: 130/ for test: prime_busy
results: parsing output: 131/ for test: gem_exec_reloc
results: parsing output: 132/ for test: gem_exec_schedule
Done.