[59.005071] Initializing watchdogs
[59.005119]   /dev/watchdog0
[59.018465] [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.022902] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.025499] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.028927] [001/133] (960s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[59.147793] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[59.152226] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[59.239763] [002/133] (960s left) syncobj_timeline (single-wait-all-available-signaled)
[59.289611] Starting subtest: single-wait-all-available-signaled
[59.291845] Subtest single-wait-all-available-signaled: SUCCESS (0.000s)
[59.402682] [003/133] (960s left) gem_eio (in-flight-10ms)
[59.538889] Starting subtest: in-flight-10ms
[66.669780] Subtest in-flight-10ms: SUCCESS (7.146s)
[66.977641] [FACT gem_eio (in-flight-10ms)] new: kernel.kmod_is_loaded.vgem: true
[66.980911] [004/133] (952s left) kms_rotation_crc (bad-tiling)
[67.448512] Starting subtest: bad-tiling
[67.453763] Subtest bad-tiling: SKIP (0.001s)
[67.754116] [005/133] (951s left) kms_cursor_crc (cursor-offscreen-512x170)
[68.197834] Starting subtest: cursor-offscreen-512x170
[68.202809] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[68.341940] [006/133] (951s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[68.441758] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu
[75.001890] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.568s)
[75.125619] [007/133] (944s left) kms_psr (fbc-pr-dpms)
[75.216613] Starting subtest: fbc-pr-dpms
[75.221095] Subtest fbc-pr-dpms: SKIP (0.000s)
[75.288726] [008/133] (944s left) gem_pxp (dmabuf-shared-protected-dst-is-context-refcounted)
[75.413916] Starting subtest: dmabuf-shared-protected-dst-is-context-refcounted
[75.548625] Subtest dmabuf-shared-protected-dst-is-context-refcounted: SUCCESS (0.137s)
[75.704931] [009/133] (944s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[75.762855] Starting subtest: multi-wait-all-for-submit-submitted
[75.864081] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.102s)
[75.953818] [010/133] (943s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping)
[76.039974] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping
[76.066052] Starting dynamic subtest: pipe-A-plane-0
[76.355055] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[76.365200] Starting dynamic subtest: pipe-A-plane-3
[76.588069] Dynamic subtest pipe-A-plane-3: SUCCESS (0.233s)
[77.723253] Starting dynamic subtest: pipe-B-plane-0
[78.016648] Dynamic subtest pipe-B-plane-0: SUCCESS (0.300s)
[78.026941] Starting dynamic subtest: pipe-B-plane-3
[78.260496] Dynamic subtest pipe-B-plane-3: SUCCESS (0.244s)
[78.570454] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping: SUCCESS (2.533s)
[79.394546] [011/133] (940s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[79.465133] Starting subtest: yf-tiled-ccs-to-x-tiled
[79.469581] Subtest yf-tiled-ccs-to-x-tiled: SKIP (0.000s)
[79.647319] [012/133] (940s left) kms_cursor_legacy (cursor-vs-flip-varying-size)
[79.757802] Starting subtest: cursor-vs-flip-varying-size
[110.633904] Subtest cursor-vs-flip-varying-size: SUCCESS (30.872s)
[111.437577] [013/133] (908s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[111.546693] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[111.563802] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.016s)
[111.646168] [014/133] (908s left) kms_dsc (dsc-with-output-formats)
[111.748296] Starting subtest: dsc-with-output-formats
[111.769822] Subtest dsc-with-output-formats: SKIP (0.001s)
[111.819908] [015/133] (908s left) gem_exec_fence (basic-busy)
[111.990313] Starting subtest: basic-busy
[111.993160] Starting dynamic subtest: rcs0
[112.066682] Dynamic subtest rcs0: SUCCESS (0.076s)
[112.076759] Starting dynamic subtest: bcs0
[112.125687] Dynamic subtest bcs0: SUCCESS (0.059s)
[112.134971] Starting dynamic subtest: vcs0
[112.178426] Dynamic subtest vcs0: SUCCESS (0.052s)
[112.188240] Starting dynamic subtest: vcs1
[112.230742] Dynamic subtest vcs1: SUCCESS (0.051s)
[112.240655] Starting dynamic subtest: vecs0
[112.280775] Dynamic subtest vecs0: SUCCESS (0.049s)
[112.290389] Starting dynamic subtest: ccs0
[112.335546] Dynamic subtest ccs0: SUCCESS (0.053s)
[112.338091] Subtest basic-busy: SUCCESS (0.346s)
[113.966631] [016/133] (906s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[114.078661] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[121.325908] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.250s)
[121.438091] [017/133] (898s left) dumb_buffer (create-clear)
[121.502075] Starting subtest: create-clear
[155.959857] Subtest create-clear: SUCCESS (34.454s)
[156.071843] [018/133] (864s left) gem_exec_schedule (preempt-self)
[156.145356] Starting subtest: preempt-self
[156.148211] Starting dynamic subtest: rcs0
[156.176066] Dynamic subtest rcs0: SUCCESS (0.037s)
[156.187770] Starting dynamic subtest: bcs0
[156.224946] Dynamic subtest bcs0: SUCCESS (0.048s)
[156.233584] Starting dynamic subtest: vcs0
[156.258673] Dynamic subtest vcs0: SUCCESS (0.033s)
[156.269714] Starting dynamic subtest: vcs1
[156.294511] Dynamic subtest vcs1: SUCCESS (0.035s)
[156.301989] Starting dynamic subtest: vecs0
[156.325718] Dynamic subtest vecs0: SUCCESS (0.031s)
[156.333635] Starting dynamic subtest: ccs0
[156.356780] Dynamic subtest ccs0: SUCCESS (0.031s)
[156.359117] Subtest preempt-self: SUCCESS (0.218s)
[157.994908] [019/133] (862s left) syncobj_wait (invalid-single-wait-unsubmitted)
[158.052032] Starting subtest: invalid-single-wait-unsubmitted
[158.054332] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[158.153584] [020/133] (862s left) gem_tiled_partial_pwrite_pread (writes-after-reads)
[158.206268] Subtest writes-after-reads: SKIP (0.000s)
[158.270798] [021/133] (862s left) gem_exec_reloc (basic-write-read)
[158.324314] Subtest basic-write-read: SKIP (0.000s)
[158.384254] [022/133] (862s left) perf (polling)
[158.492631] Starting subtest: polling
[158.494585] Starting dynamic subtest: 0-rcs0
[168.525553] Dynamic subtest 0-rcs0: SUCCESS (10.032s)
[168.534493] Starting dynamic subtest: 1-vcs0
[178.543884] Dynamic subtest 1-vcs0: SUCCESS (10.017s)
[178.546582] Subtest polling: SUCCESS (20.051s)
[178.591600] [023/133] (841s left) kms_vblank (ts-continuation-dpms-rpm)
[178.678228] Starting subtest: ts-continuation-dpms-rpm
[178.680519] Starting dynamic subtest: pipe-A-eDP-1
[181.244253] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.563s)
[181.257616] Starting dynamic subtest: pipe-D-eDP-1
[183.503871] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.258s)
[183.505914] Subtest ts-continuation-dpms-rpm: SUCCESS (4.824s)
[184.397839] [024/133] (836s left) kms_sequence (get-idle)
[184.504065] Starting subtest: get-idle
[184.506398] Starting dynamic subtest: pipe-A-eDP-1
[186.319831] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.813s)
[186.329147] Starting dynamic subtest: pipe-B-eDP-1
[188.758504] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.439s)
[188.767227] Starting dynamic subtest: pipe-C-eDP-1
[191.187267] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.426s)
[191.196239] Starting dynamic subtest: pipe-D-eDP-1
[193.630368] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.443s)
[193.632719] Subtest get-idle: SUCCESS (9.125s)
[194.426320] [025/133] (826s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-upscaling)
[194.538057] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-upscaling
[194.542252] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-upscaling: SKIP (0.000s)
[194.608234] [026/133] (825s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs)
[194.697779] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs
[194.700134] Starting dynamic subtest: pipe-A-eDP-1
[194.722934] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[194.732806] Starting dynamic subtest: pipe-B-eDP-1
[194.754436] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[194.762404] Starting dynamic subtest: pipe-C-eDP-1
[194.783559] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[194.791203] Starting dynamic subtest: pipe-D-eDP-1
[194.813389] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[194.817518] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[196.913507] [027/133] (823s left) gem_exec_fence (parallel)
[197.095061] Starting subtest: parallel
[197.097212] Starting dynamic subtest: rcs0
[199.242249] Dynamic subtest rcs0: SUCCESS (2.151s)
[199.251937] Starting dynamic subtest: bcs0
[201.391137] Dynamic subtest bcs0: SUCCESS (2.148s)
[201.401074] Starting dynamic subtest: vcs0
[203.543908] Dynamic subtest vcs0: SUCCESS (2.152s)
[203.554708] Starting dynamic subtest: vcs1
[205.699639] Dynamic subtest vcs1: SUCCESS (2.155s)
[205.707347] Starting dynamic subtest: vecs0
[207.852951] Dynamic subtest vecs0: SUCCESS (2.153s)
[207.861147] Starting dynamic subtest: ccs0
[210.002420] Dynamic subtest ccs0: SUCCESS (2.149s)
[210.004649] Subtest parallel: SUCCESS (12.911s)
[211.001415] [028/133] (809s left) gem_ctx_shared (detached-shared-gtt)
[211.070121] Starting subtest: detached-shared-gtt
[213.223646] Subtest detached-shared-gtt: SUCCESS (2.155s)
[213.535161] [029/133] (807s left) gem_eio (wait-immediate)
[213.757953] Starting subtest: wait-immediate
[214.162546] Subtest wait-immediate: SUCCESS (0.404s)
[214.309400] [030/133] (806s left) kms_addfb_basic (no-handle)
[214.362376] Starting subtest: no-handle
[214.364583] Subtest no-handle: SUCCESS (0.000s)
[214.495312] [031/133] (806s left) kms_color_pipeline (plane-ctm3x4-lut1d)
[214.587726] Starting subtest: plane-ctm3x4-lut1d
[214.769433] Starting dynamic subtest: pipe-A-plane-0
[215.060103] Dynamic subtest pipe-A-plane-0: FAIL (0.152s)
[215.067125] Starting dynamic subtest: pipe-A-plane-1
[215.254712] Dynamic subtest pipe-A-plane-1: FAIL (0.160s)
[215.264899] Starting dynamic subtest: pipe-A-plane-2
[215.473887] Dynamic subtest pipe-A-plane-2: FAIL (0.184s)
[216.484643] Starting dynamic subtest: pipe-B-plane-0
[216.895930] Dynamic subtest pipe-B-plane-0: FAIL (0.141s)
[216.906208] Starting dynamic subtest: pipe-B-plane-1
[217.219601] Dynamic subtest pipe-B-plane-1: FAIL (0.171s)
[217.228846] Starting dynamic subtest: pipe-B-plane-2
[217.525935] Dynamic subtest pipe-B-plane-2: FAIL (0.183s)
[218.138675] Starting dynamic subtest: pipe-C-plane-0
[218.647281] Dynamic subtest pipe-C-plane-0: FAIL (0.140s)
[218.655059] Starting dynamic subtest: pipe-C-plane-1
[219.048205] Dynamic subtest pipe-C-plane-1: FAIL (0.623s)
[219.056378] Starting dynamic subtest: pipe-C-plane-2
[219.417776] Dynamic subtest pipe-C-plane-2: FAIL (0.168s)
[220.251920] Starting dynamic subtest: pipe-D-plane-0
[220.858650] Dynamic subtest pipe-D-plane-0: FAIL (0.151s)
[220.868810] Starting dynamic subtest: pipe-D-plane-1
[221.324164] Dynamic subtest pipe-D-plane-1: FAIL (0.609s)
[221.333644] Starting dynamic subtest: pipe-D-plane-2
[221.770565] Dynamic subtest pipe-D-plane-2: FAIL (0.539s)
[221.844854] Subtest plane-ctm3x4-lut1d: FAIL (7.257s)
[222.725303] [032/133] (798s left) gem_exec_reloc (basic-wc-gtt)
[222.796790] Subtest basic-wc-gtt: SKIP (0.000s)
[222.867709] [033/133] (798s left) syncobj_timeline (etime-multi-wait-submitted)
[222.912875] Starting subtest: etime-multi-wait-submitted
[223.017143] Subtest etime-multi-wait-submitted: SUCCESS (0.104s)
[223.091578] [034/133] (797s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-onoff)
[223.184243] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-onoff
[223.188628] Subtest fbcpsr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[223.285372] [035/133] (797s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[223.394308] Starting subtest: y-tiled-32bpp-rotate-0
[223.398529] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[223.474892] [036/133] (797s left) kms_flip (flip-vs-rmfb)
[223.567303] Starting subtest: flip-vs-rmfb
[223.569187] Starting dynamic subtest: A-eDP1
[232.209120] Dynamic subtest A-eDP1: SUCCESS (8.643s)
[232.222206] Starting dynamic subtest: B-eDP1
[240.851116] Dynamic subtest B-eDP1: SUCCESS (8.639s)
[240.861882] Starting dynamic subtest: C-eDP1
[249.474493] Dynamic subtest C-eDP1: SUCCESS (8.620s)
[249.488231] Starting dynamic subtest: D-eDP1
[258.104055] Dynamic subtest D-eDP1: SUCCESS (8.628s)
[258.108627] Subtest flip-vs-rmfb: SUCCESS (34.544s)
[259.288378] [037/133] (761s left) kms_atomic (plane-immutable-zpos)
[259.377907] Starting subtest: plane-immutable-zpos
[259.380139] Starting dynamic subtest: pipe-A-eDP-1
[260.042437] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.664s)
[260.044803] Subtest plane-immutable-zpos: SUCCESS (0.665s)
[260.917057] [038/133] (760s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[260.970698] Starting subtest: multi-wait-for-submit-submitted-signaled
[260.973074] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s)
[261.085822] [039/133] (760s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[261.173510] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[261.177700] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[261.264966] [040/133] (759s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs)
[261.351822] Starting subtest: bad-rotation-90-y-tiled-gen12-rc-ccs
[261.353946] Starting dynamic subtest: pipe-A-eDP-1
[261.375741] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[261.385552] Starting dynamic subtest: pipe-B-eDP-1
[261.406023] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[261.413665] Starting dynamic subtest: pipe-C-eDP-1
[261.434158] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[261.441725] Starting dynamic subtest: pipe-D-eDP-1
[261.463224] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[261.467186] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[263.612307] [041/133] (757s left) sysfs_timeslice_duration (timeout)
[263.666389] Starting subtest: timeout
[263.668366] Starting dynamic subtest: vecs0
[272.912232] Dynamic subtest vecs0: SUCCESS (9.244s)
[272.921750] Starting dynamic subtest: ccs0
[274.200101] Dynamic subtest ccs0: SUCCESS (1.287s)
[274.209198] Starting dynamic subtest: vcs0
[283.921820] Dynamic subtest vcs0: SUCCESS (9.718s)
[283.932381] Starting dynamic subtest: bcs0
[284.517692] Dynamic subtest bcs0: SUCCESS (0.596s)
[284.528652] Starting dynamic subtest: rcs0
[285.797518] Dynamic subtest rcs0: SUCCESS (1.279s)
[285.808386] Starting dynamic subtest: vcs1
[294.927602] Dynamic subtest vcs1: SUCCESS (9.125s)
[294.930105] Subtest timeout: SUCCESS (31.260s)
[295.005478] [042/133] (726s left) kms_big_fb (4-tiled-addfb)
[295.116151] Starting subtest: 4-tiled-addfb
[295.118559] Subtest 4-tiled-addfb: SUCCESS (0.000s)
[295.212949] [043/133] (726s left) kms_rotation_crc (primary-y-tiled-reflect-x-270)
[295.312064] Starting subtest: primary-y-tiled-reflect-x-270
[295.316735] Subtest primary-y-tiled-reflect-x-270: SKIP (0.001s)
[295.385848] [044/133] (725s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[295.472611] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[295.477064] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[295.578701] [045/133] (725s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[295.672315] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[295.676320] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[295.754545] [046/133] (725s left) kms_big_fb (yf-tiled-8bpp-rotate-180)
[295.880320] Starting subtest: yf-tiled-8bpp-rotate-180
[295.885051] Subtest yf-tiled-8bpp-rotate-180: SKIP (0.000s)
[295.974581] [047/133] (725s left) perf_pmu (busy-start)
[296.016044] Starting subtest: busy-start
[296.017826] Starting dynamic subtest: rcs0
[298.565435] Dynamic subtest rcs0: SUCCESS (2.551s)
[298.576321] Starting dynamic subtest: bcs0
[301.115793] Dynamic subtest bcs0: SUCCESS (2.548s)
[301.126999] Starting dynamic subtest: vcs0
[304.916313] Dynamic subtest vcs0: SUCCESS (3.797s)
[304.926585] Starting dynamic subtest: vcs1
[308.884530] Dynamic subtest vcs1: SUCCESS (3.965s)
[308.896123] Starting dynamic subtest: vecs0
[312.916825] Dynamic subtest vecs0: SUCCESS (4.029s)
[312.928462] Starting dynamic subtest: ccs0
[315.466790] Dynamic subtest ccs0: SUCCESS (2.549s)
[315.469273] Subtest busy-start: SUCCESS (19.453s)
[315.575767] [048/133] (705s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[315.667166] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[315.669422] Starting dynamic subtest: pipe-A-eDP-1
[315.694285] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[315.703773] Starting dynamic subtest: pipe-B-eDP-1
[315.727089] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[315.734958] Starting dynamic subtest: pipe-C-eDP-1
[315.758809] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[315.766488] Starting dynamic subtest: pipe-D-eDP-1
[315.790556] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[315.794897] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.004s)
[317.948383] [049/133] (703s left) gem_userptr_blits (invalid-mmap-offset-unsync)
[318.014834] Subtest invalid-mmap-offset-unsync: SKIP (0.000s)
[318.127532] [050/133] (703s left) gem_workarounds (reset)
[318.191690] Starting subtest: reset
[318.335318] Subtest reset: SUCCESS (0.144s)
[318.448882] [051/133] (703s left) kms_invalid_mode (zero-vdisplay)
[318.543289] Starting subtest: zero-vdisplay
[318.545604] Starting dynamic subtest: pipe-A-eDP-1
[318.835873] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.296s)
[318.845481] Starting dynamic subtest: pipe-B-eDP-1
[318.847487] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[318.855436] Starting dynamic subtest: pipe-C-eDP-1
[318.857372] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[318.865394] Starting dynamic subtest: pipe-D-eDP-1
[318.867627] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[318.869790] Subtest zero-vdisplay: SUCCESS (0.301s)
[319.683843] [052/133] (701s left) gen9_exec_parse (batch-zero-length)
[319.736472] Subtest batch-zero-length: SKIP (0.000s)
[319.793362] [053/133] (701s left) syncobj_eventfd (timeline-wait-before-signal)
[319.844481] Starting subtest: timeline-wait-before-signal
[319.873712] Subtest timeline-wait-before-signal: SUCCESS (0.031s)
[319.950428] [054/133] (701s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-pgflip-blt)
[320.041159] Starting subtest: fbc-2p-scndscrn-indfb-pgflip-blt
[320.045785] Subtest fbc-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[320.147658] [055/133] (701s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[320.245447] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[327.644308] Subtest psr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.400s)
[327.767143] [056/133] (694s left) kms_psr2_sf (fbc-pr-overlay-primary-update-sf-dmg-area)
[327.869375] Starting subtest: fbc-pr-overlay-primary-update-sf-dmg-area
[327.873586] Subtest fbc-pr-overlay-primary-update-sf-dmg-area: SKIP (0.000s)
[327.940633] [057/133] (693s left) kms_cursor_legacy (cursora-vs-flipa-legacy)
[328.050137] Starting subtest: cursorA-vs-flipA-legacy
[339.190331] Subtest cursorA-vs-flipA-legacy: SUCCESS (11.139s)
[340.066974] [058/133] (681s left) kms_scaling_modes (scaling-mode-full-aspect)
[340.163058] Starting subtest: scaling-mode-full-aspect
[340.165370] Starting dynamic subtest: pipe-A-eDP-1
[340.256949] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.095s)
[340.269120] Starting dynamic subtest: pipe-B-eDP-1
[341.487675] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.227s)
[341.497720] Starting dynamic subtest: pipe-C-eDP-1
[342.602385] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.114s)
[342.610869] Starting dynamic subtest: pipe-D-eDP-1
[343.740806] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.136s)
[343.743072] Subtest scaling-mode-full-aspect: SUCCESS (3.580s)
[344.897424] [059/133] (677s left) kms_flip (plain-flip-fb-recreate-interruptible)
[345.012775] Starting subtest: plain-flip-fb-recreate-interruptible
[345.015097] Starting dynamic subtest: A-eDP1
[353.890578] Dynamic subtest A-eDP1: SUCCESS (8.876s)
[353.905199] Starting dynamic subtest: B-eDP1
[362.715985] Dynamic subtest B-eDP1: SUCCESS (8.824s)
[362.727156] Starting dynamic subtest: C-eDP1
[371.534671] Dynamic subtest C-eDP1: SUCCESS (8.816s)
[371.545498] Starting dynamic subtest: D-eDP1
[380.372654] Dynamic subtest D-eDP1: SUCCESS (8.835s)
[380.377444] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.363s)
[381.577927] [060/133] (640s left) gem_render_copy (x-tiled)
[381.649359] Starting subtest: x-tiled
[381.651689] Starting dynamic subtest: smem
[381.688061] Dynamic subtest smem: SUCCESS (0.041s)
[381.690548] Subtest x-tiled: SUCCESS (0.042s)
[381.898816] [061/133] (640s left) gem_exec_balancer (full-late)
[381.959848] Starting subtest: full-late
[386.704725] Subtest full-late: SUCCESS (4.745s)
[387.011013] [062/133] (635s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[387.121265] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc
[393.780221] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (6.660s)
[393.921598] [063/133] (628s left) kms_setmode (invalid-clone-single-crtc-stealing)
[393.973264] Starting subtest: invalid-clone-single-crtc-stealing
[393.979610] Subtest invalid-clone-single-crtc-stealing: SKIP (0.000s)
[394.087293] [064/133] (628s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[394.178184] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[398.649943] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.477s)
[399.782082] [065/133] (622s left) i915_hangman (engine-engine-error)
[399.850351] Starting subtest: engine-engine-error
[399.852332] Starting dynamic subtest: rcs0
[401.843449] Dynamic subtest rcs0: SUCCESS (1.993s)
[401.855529] Starting dynamic subtest: bcs0
[403.891818] Dynamic subtest bcs0: SUCCESS (2.045s)
[403.903635] Starting dynamic subtest: vcs0
[405.874832] Dynamic subtest vcs0: SUCCESS (1.980s)
[405.886282] Starting dynamic subtest: vcs1
[407.858352] Dynamic subtest vcs1: SUCCESS (1.981s)
[407.870985] Starting dynamic subtest: vecs0
[409.843139] Dynamic subtest vecs0: SUCCESS (1.982s)
[409.855098] Starting dynamic subtest: ccs0
[411.891360] Dynamic subtest ccs0: SUCCESS (2.045s)
[411.894272] Subtest engine-engine-error: SUCCESS (12.043s)
[412.058891] [066/133] (610s left) api_intel_bb (intel-bb-blit-y)
[412.133169] Starting subtest: intel-bb-blit-y
[415.807828] Subtest intel-bb-blit-y: SUCCESS (3.675s)
[415.915594] [067/133] (606s left) drm_read (invalid-buffer)
[416.058545] Starting subtest: invalid-buffer
[416.060890] Subtest invalid-buffer: SUCCESS (0.000s)
[416.182852] [068/133] (606s left) gem_exec_reloc (basic-wc)
[416.247638] Subtest basic-wc: SKIP (0.000s)
[416.318581] [069/133] (606s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs)
[416.410916] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs
[416.415360] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s)
[417.506976] [070/133] (604s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-wc)
[417.608764] Starting subtest: fbcpsr-rgb101010-draw-mmap-wc
[424.304576] Subtest fbcpsr-rgb101010-draw-mmap-wc: SUCCESS (6.699s)
[424.415525] [071/133] (598s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[424.510454] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[424.884396] Starting dynamic subtest: pipe-A-eDP-1
[427.686286] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.801s)
[428.049574] Starting dynamic subtest: pipe-B-eDP-1
[430.816639] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.772s)
[431.195744] Starting dynamic subtest: pipe-C-eDP-1
[433.946218] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.756s)
[434.307346] Starting dynamic subtest: pipe-D-eDP-1
[437.083945] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.781s)
[437.086675] Subtest async-flip-with-page-flip-events-linear-atomic: SUCCESS (12.573s)
[438.271330] [072/133] (584s left) kms_cursor_crc (cursor-sliding-256x85)
[438.543792] Starting subtest: cursor-sliding-256x85
[438.591882] Subtest cursor-sliding-256x85: SKIP (0.043s)
[438.766497] [073/133] (583s left) kms_psr (psr2-sprite-mmap-gtt)
[438.867757] Starting subtest: psr2-sprite-mmap-gtt
[438.870036] Starting dynamic subtest: eDP-1
[440.279080] Dynamic subtest eDP-1: SKIP (1.408s)
[440.284297] Subtest psr2-sprite-mmap-gtt: SKIP (1.410s)
[440.430887] [074/133] (582s left) kms_prime (basic-modeset-hybrid)
[440.510726] Subtest basic-modeset-hybrid: SKIP (0.000s)
[440.604697] [075/133] (582s left) gem_exec_suspend (basic)
[440.662288] Starting subtest: basic
[440.664629] Starting dynamic subtest: smem
[441.875674] Dynamic subtest smem: SUCCESS (1.212s)
[441.877990] Subtest basic: SUCCESS (1.213s)
[442.060132] [076/133] (580s left) kms_chamelium_hpd (dp-hpd-storm)
[442.438868] Subtest dp-hpd-storm: SKIP (0.000s)
[443.217595] [077/133] (579s left) kms_big_fb (yf-tiled-32bpp-rotate-0)
[443.316079] Starting subtest: yf-tiled-32bpp-rotate-0
[443.320288] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s)
[443.406176] [078/133] (579s left) kms_pm_rpm (cursor)
[445.030188] Starting subtest: cursor
[445.035639] Subtest cursor: SKIP (0.000s)
[445.675230] [079/133] (577s left) drm_read (fault-buffer)
[445.818233] Starting subtest: fault-buffer
[445.820776] Subtest fault-buffer: SUCCESS (0.000s)
[445.945948] [080/133] (576s left) i915_query (test-query-geometry-subslices)
[445.996075] Starting subtest: test-query-geometry-subslices
[445.997976] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[446.122512] [081/133] (576s left) gem_exec_schedule (preempt-hang)
[446.295104] Starting subtest: preempt-hang
[446.297407] Starting dynamic subtest: rcs0
[446.528231] Dynamic subtest rcs0: SUCCESS (0.235s)
[446.537608] Starting dynamic subtest: bcs0
[446.760265] Dynamic subtest bcs0: SUCCESS (0.231s)
[446.771190] Starting dynamic subtest: vcs0
[446.992423] Dynamic subtest vcs0: SUCCESS (0.231s)
[447.003433] Starting dynamic subtest: vcs1
[447.223708] Dynamic subtest vcs1: SUCCESS (0.230s)
[447.234052] Starting dynamic subtest: vecs0
[447.452244] Dynamic subtest vecs0: SUCCESS (0.226s)
[447.462349] Starting dynamic subtest: ccs0
[447.680738] Dynamic subtest ccs0: SUCCESS (0.228s)
[447.683050] Subtest preempt-hang: SUCCESS (1.388s)
[447.999237] [082/133] (574s left) gem_spin_batch (resubmit-all)
[448.059759] Starting subtest: resubmit-all
[448.062170] Starting dynamic subtest: rcs0
[448.070224] Dynamic subtest rcs0: SUCCESS (0.010s)
[448.080313] Starting dynamic subtest: bcs0
[448.082630] Dynamic subtest bcs0: SUCCESS (0.002s)
[448.100751] Starting dynamic subtest: vcs0
[448.103046] Dynamic subtest vcs0: SUCCESS (0.002s)
[448.115938] Starting dynamic subtest: vcs1
[448.118083] Dynamic subtest vcs1: SUCCESS (0.002s)
[448.126422] Starting dynamic subtest: vecs0
[448.128323] Dynamic subtest vecs0: SUCCESS (0.002s)
[448.136482] Starting dynamic subtest: ccs0
[448.138377] Dynamic subtest ccs0: SUCCESS (0.002s)
[448.140369] Subtest resubmit-all: SUCCESS (0.023s)
[449.981982] [083/133] (572s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move)
[450.090306] Starting subtest: psr-2p-primscrn-cur-indfb-move
[450.094224] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[450.199013] [084/133] (572s left) kms_cursor_crc (cursor-random-256x256)
[450.434100] Starting subtest: cursor-random-256x256
[450.438851] Starting dynamic subtest: pipe-A-eDP-1
[453.746078] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.308s)
[453.774508] Starting dynamic subtest: pipe-D-eDP-1
[457.851675] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.082s)
[457.853662] Subtest cursor-random-256x256: SUCCESS (7.415s)
[458.706359] [085/133] (564s left) gem_exec_schedule (fifo)
[458.778602] Starting subtest: fifo
[458.780834] Starting dynamic subtest: rcs0
[458.884786] Dynamic subtest rcs0: SUCCESS (0.115s)
[458.896281] Starting dynamic subtest: vcs0
[458.965926] Dynamic subtest vcs0: SUCCESS (0.080s)
[458.979062] Starting dynamic subtest: vcs1
[459.046646] Dynamic subtest vcs1: SUCCESS (0.079s)
[459.057797] Starting dynamic subtest: vecs0
[459.130042] Dynamic subtest vecs0: SUCCESS (0.082s)
[459.140846] Starting dynamic subtest: ccs0
[459.215084] Dynamic subtest ccs0: SUCCESS (0.084s)
[459.217881] Subtest fifo: SUCCESS (0.445s)
[460.969970] [086/133] (562s left) gem_render_copy (yf-tiled-ccs-to-y-tiled)
[461.029272] Starting subtest: yf-tiled-ccs-to-y-tiled
[461.033704] Subtest yf-tiled-ccs-to-y-tiled: SKIP (0.000s)
[461.211754] [087/133] (561s left) gem_ctx_engines (independent)
[461.277089] Starting subtest: independent
[461.279926] Starting dynamic subtest: rcs0
[461.533224] Dynamic subtest rcs0: SUCCESS (0.255s)
[461.545074] Starting dynamic subtest: bcs0
[461.776946] Dynamic subtest bcs0: SUCCESS (0.242s)
[461.788826] Starting dynamic subtest: vcs0
[462.035509] Dynamic subtest vcs0: SUCCESS (0.258s)
[462.045301] Starting dynamic subtest: vcs1
[462.337876] Dynamic subtest vcs1: SUCCESS (0.301s)
[462.347272] Starting dynamic subtest: vecs0
[462.629776] Dynamic subtest vecs0: SUCCESS (0.291s)
[462.639691] Starting dynamic subtest: ccs0
[462.968072] Dynamic subtest ccs0: SUCCESS (0.338s)
[462.980737] Starting dynamic subtest: all-engines
[464.516399] Dynamic subtest all-engines: SUCCESS (1.546s)
[464.518756] Subtest independent: SUCCESS (3.238s)
[465.021722] [088/133] (558s left) syncobj_timeline (invalid-transfer-non-existent-point)
[465.084462] Starting subtest: invalid-transfer-non-existent-point
[465.086813] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[465.194744] [089/133] (558s left) kms_dp_link_training (non-uhbr-mst)
[465.292650] Starting subtest: non-uhbr-mst
[465.301188] Subtest non-uhbr-mst: SKIP (0.000s)
[465.366407] [090/133] (557s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-onoff)
[465.483168] Starting subtest: fbc-1p-primscrn-cur-indfb-onoff
[469.443616] Subtest fbc-1p-primscrn-cur-indfb-onoff: SUCCESS (3.965s)
[470.641960] [091/133] (552s left) gem_exec_whisper (basic-sync-all)
[470.712823] Starting subtest: basic-sync-all
[478.499860] Subtest basic-sync-all: SUCCESS (7.784s)
[478.695896] [092/133] (544s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[478.804846] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[478.809324] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.000s)
[478.876455] [093/133] (544s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt)
[478.971602] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt
[478.975822] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[479.087235] [094/133] (544s left) prime_vgem (coherency-blt)
[479.160450] Starting subtest: coherency-blt
[480.323461] Subtest coherency-blt: SUCCESS (1.161s)
[480.451779] [095/133] (543s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[480.537485] Starting subtest: compare-crc-sanitycheck-nv12
[480.539742] Starting dynamic subtest: pipe-A-eDP-1
[481.218747] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.680s)
[481.228123] Starting dynamic subtest: pipe-B-eDP-1
[482.512366] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.292s)
[482.522079] Starting dynamic subtest: pipe-C-eDP-1
[483.790842] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.277s)
[483.799920] Starting dynamic subtest: pipe-D-eDP-1
[484.977753] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.188s)
[484.980145] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.443s)
[485.837430] [096/133] (537s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180)
[485.935915] Starting subtest: linear-max-hw-stride-64bpp-rotate-180
[487.059408] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (1.124s)
[487.172753] [097/133] (536s left) kms_lease (lease-get)
[487.256057] Starting subtest: lease-get
[487.257867] Starting dynamic subtest: pipe-A-eDP-1
[487.259781] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[487.272797] Starting dynamic subtest: pipe-B-eDP-1
[487.274478] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[487.286378] Starting dynamic subtest: pipe-C-eDP-1
[487.288382] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[487.296075] Starting dynamic subtest: pipe-D-eDP-1
[487.297592] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[487.299102] Subtest lease-get: SUCCESS (0.009s)
[487.366085] [098/133] (536s left) gem_lmem_swapping (verify-random-ccs)
[487.409966] Subtest verify-random-ccs: SKIP (0.000s)
[487.467601] [099/133] (536s left) kms_psr (fbc-pr-primary-render)
[487.552029] Starting subtest: fbc-pr-primary-render
[487.555830] Subtest fbc-pr-primary-render: SKIP (0.000s)
[487.624092] [100/133] (536s left) gem_exec_params (rsvd2-dirt)
[487.674366] Starting subtest: rsvd2-dirt
[487.678238] Subtest rsvd2-dirt: SKIP (0.000s)
[487.782774] [101/133] (535s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[487.908230] Starting subtest: cursorA-vs-flipB-atomic-transitions
[487.912204] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[488.066927] [102/133] (535s left) kms_plane (plane-position-hole)
[488.156199] Starting subtest: plane-position-hole
[488.658166] Starting dynamic subtest: pipe-A-plane-1
[489.934178] Dynamic subtest pipe-A-plane-1: SUCCESS (1.276s)
[489.944235] Starting dynamic subtest: pipe-A-plane-2
[491.258544] Dynamic subtest pipe-A-plane-2: SUCCESS (1.322s)
[491.268755] Starting dynamic subtest: pipe-A-plane-3
[492.569370] Dynamic subtest pipe-A-plane-3: SUCCESS (1.309s)
[492.578698] Starting dynamic subtest: pipe-A-plane-4
[493.860681] Dynamic subtest pipe-A-plane-4: SUCCESS (1.290s)
[493.870601] Starting dynamic subtest: pipe-A-plane-5
[493.884088] Dynamic subtest pipe-A-plane-5: SUCCESS (0.023s)
[495.051883] Starting dynamic subtest: pipe-B-plane-1
[496.313162] Dynamic subtest pipe-B-plane-1: SUCCESS (1.270s)
[496.329638] Starting dynamic subtest: pipe-B-plane-2
[497.605833] Dynamic subtest pipe-B-plane-2: SUCCESS (1.290s)
[497.617043] Starting dynamic subtest: pipe-B-plane-3
[498.834628] Dynamic subtest pipe-B-plane-3: SUCCESS (1.228s)
[498.844618] Starting dynamic subtest: pipe-B-plane-4
[500.061852] Dynamic subtest pipe-B-plane-4: SUCCESS (1.226s)
[500.072692] Starting dynamic subtest: pipe-B-plane-5
[500.088379] Dynamic subtest pipe-B-plane-5: SUCCESS (0.024s)
[500.090739] Subtest plane-position-hole: SUCCESS (11.932s)
[500.872426] [103/133] (522s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[500.988366] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[500.992452] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[501.083835] [104/133] (522s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions-varying-size)
[501.185814] Starting subtest: short-flip-after-cursor-atomic-transitions-varying-size
[502.165763] Subtest short-flip-after-cursor-atomic-transitions-varying-size: SUCCESS (0.978s)
[503.003210] [105/133] (520s left) gem_ctx_persistence (engines-queued)
[503.062790] Starting subtest: engines-queued
[503.065122] Starting dynamic subtest: rcs0
[503.144933] Dynamic subtest rcs0: SUCCESS (0.081s)
[503.156805] Starting dynamic subtest: bcs0
[503.192690] Dynamic subtest bcs0: SUCCESS (0.046s)
[503.203078] Starting dynamic subtest: vcs0
[504.885436] Dynamic subtest vcs0: SUCCESS (1.688s)
[504.897358] Starting dynamic subtest: vcs1
[506.867557] Dynamic subtest vcs1: SUCCESS (1.979s)
[506.879630] Starting dynamic subtest: vecs0
[508.851429] Dynamic subtest vecs0: SUCCESS (1.980s)
[508.863626] Starting dynamic subtest: ccs0
[509.023333] Dynamic subtest ccs0: SUCCESS (0.171s)
[509.025915] Subtest engines-queued: SUCCESS (5.961s)
[509.135953] [106/133] (514s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180)
[509.239599] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180
[509.244146] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s)
[509.335433] [107/133] (514s left) kms_atomic_transition (plane-all-transition)
[509.417306] Starting subtest: plane-all-transition
[509.419655] Starting dynamic subtest: pipe-A-eDP-1
[511.911053] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.495s)
[512.232227] Starting dynamic subtest: pipe-B-eDP-1
[515.443560] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.221s)
[515.749300] Subtest plane-all-transition: SUCCESS (6.331s)
[516.586080] [108/133] (507s left) gem_ctx_persistence (many-contexts)
[516.654264] Starting subtest: many-contexts
[561.849578] Subtest many-contexts: SUCCESS (45.194s)
[561.930657] [109/133] (462s left) kms_vrr (flip-suspend)
[562.036076] Starting subtest: flip-suspend
[562.042455] Subtest flip-suspend: SKIP (0.000s)
[562.123154] [110/133] (461s left) prime_vgem (fence-read-hang)
[562.199671] Subtest fence-read-hang: SKIP (0.000s)
[562.300859] [111/133] (461s left) gem_softpin (evict-active-interruptible)
[562.370599] Starting subtest: evict-active-interruptible
[562.378712] Subtest evict-active-interruptible: SUCCESS (0.007s)
[562.504322] [112/133] (461s left) gem_ctx_param (basic-default)
[562.567953] Starting subtest: basic-default
[562.570765] Subtest basic-default: SUCCESS (0.000s)
[562.665017] [113/133] (461s left) kms_psr (pr-primary-render)
[562.749672] Starting subtest: pr-primary-render
[562.753857] Subtest pr-primary-render: SKIP (0.000s)
[562.836533] [114/133] (461s left) kms_big_fb (linear-32bpp-rotate-270)
[562.950484] Starting subtest: linear-32bpp-rotate-270
[562.969948] Subtest linear-32bpp-rotate-270: SKIP (0.019s)
[563.075376] [115/133] (461s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-75)
[563.171219] Starting subtest: planes-unity-scaling-downscale-factor-0-75
[563.173128] Starting dynamic subtest: pipe-A
[563.232610] Dynamic subtest pipe-A: SUCCESS (0.064s)
[563.241982] Starting dynamic subtest: pipe-B
[564.394867] Dynamic subtest pipe-B: SUCCESS (1.160s)
[564.405741] Starting dynamic subtest: pipe-C
[565.521184] Dynamic subtest pipe-C: SUCCESS (1.124s)
[565.537646] Starting dynamic subtest: pipe-D
[566.641484] Dynamic subtest pipe-D: SUCCESS (1.119s)
[566.643798] Subtest planes-unity-scaling-downscale-factor-0-75: SUCCESS (3.473s)
[567.814297] [116/133] (456s left) gem_mmap_offset (open-flood)
[567.866092] Starting subtest: open-flood
[589.354687] Subtest open-flood: SUCCESS (21.490s)
[589.469830] [117/133] (434s left) gen9_exec_parse (shadow-peek)
[589.544088] Subtest shadow-peek: SKIP (0.000s)
[589.615066] [118/133] (434s left) kms_content_protection (suspend-resume)
[589.747267] Starting subtest: suspend-resume
[589.750765] Subtest suspend-resume: SKIP (0.000s)
[589.869837] [119/133] (434s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render)
[589.966488] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render
[589.969867] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[590.060738] [120/133] (434s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-plflip-blt)
[590.156828] Starting subtest: psr-2p-scndscrn-shrfb-plflip-blt
[590.160487] Subtest psr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[590.253126] [121/133] (434s left) gem_exec_schedule (wide)
[590.425043] Starting subtest: wide
[590.427723] Starting dynamic subtest: rcs0
[600.572251] Dynamic subtest rcs0: SUCCESS (10.145s)
[600.589989] Starting dynamic subtest: vcs0
[610.650991] Dynamic subtest vcs0: SUCCESS (10.077s)
[610.662903] Starting dynamic subtest: vcs1
[621.183983] Dynamic subtest vcs1: SUCCESS (10.533s)
[621.193311] Starting dynamic subtest: vecs0
[632.920560] Dynamic subtest vecs0: SUCCESS (11.734s)
[632.934730] Starting dynamic subtest: ccs0
[647.816077] Dynamic subtest ccs0: SUCCESS (14.894s)
[647.818631] Subtest wide: SUCCESS (57.388s)
[650.690592] [122/133] (373s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[650.799780] Starting subtest: fbc-psr-cursor-mmap-cpu
[650.802089] Starting dynamic subtest: eDP-1
[650.806251] Dynamic subtest eDP-1: SKIP (0.000s)
[650.810503] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.001s)
[650.887573] [123/133] (373s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[650.996320] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[651.000574] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[651.097290] [124/133] (373s left) kms_chamelium_edid (dp-edid-resolution-list)
[651.487495] Subtest dp-edid-resolution-list: SKIP (0.000s)
[652.308995] [125/133] (372s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier)
[652.406779] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier
[652.411060] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s)
[652.477497] [126/133] (372s left) prime_mmap (test_userptr)
[652.532048] Starting subtest: test_userptr
[652.534212] Starting dynamic subtest: test_userptr-smem
[652.536063] Dynamic subtest test_userptr-smem: SUCCESS (0.000s)
[652.537926] Subtest test_userptr: SUCCESS (0.001s)
[652.649346] [127/133] (372s left) gem_basic (create-close)
[652.708895] Starting subtest: create-close
[652.713233] Subtest create-close: SUCCESS (0.000s)
[652.821353] [128/133] (372s left) kms_chamelium_audio (hdmi-audio-edid)
[653.205222] Subtest hdmi-audio-edid: SKIP (0.000s)
[654.029743] [129/133] (370s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-wc)
[654.134057] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-wc
[660.826955] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (6.696s)
[660.955626] [130/133] (363s left) gem_busy (busy)
[661.029399] Starting subtest: busy
[661.031828] Starting dynamic subtest: all-engines
[661.090322] Dynamic subtest all-engines: SUCCESS (0.061s)
[661.099618] Starting dynamic subtest: rcs0
[662.876764] Dynamic subtest rcs0: SUCCESS (1.784s)
[662.886509] Starting dynamic subtest: bcs0
[662.927565] Dynamic subtest bcs0: SUCCESS (0.048s)
[662.935820] Starting dynamic subtest: vcs0
[662.966862] Dynamic subtest vcs0: SUCCESS (0.038s)
[662.977823] Starting dynamic subtest: vcs1
[664.922967] Dynamic subtest vcs1: SUCCESS (1.954s)
[664.934029] Starting dynamic subtest: vecs0
[666.907386] Dynamic subtest vecs0: SUCCESS (1.980s)
[666.918601] Starting dynamic subtest: ccs0
[668.891259] Dynamic subtest ccs0: SUCCESS (1.984s)
[668.893415] Subtest busy: SUCCESS (7.859s)
[669.251937] [131/133] (355s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[669.357397] Starting subtest: pr-cursor-plane-move-continuous-sf
[669.361858] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[669.431732] [132/133] (355s left) gem_exec_params (cliprects-invalid)
[669.496841] Starting subtest: cliprects-invalid
[669.499204] Subtest cliprects-invalid: SUCCESS (0.000s)
[669.599561] [133/133] (355s left) i915_pm_rps (reset)
[669.654790] Starting subtest: reset
[678.102698] Subtest reset: SUCCESS (8.449s)
[678.224495] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: syncobj_timeline
results: parsing output: 2/ for test: gem_eio
results: parsing output: 3/ for test: kms_rotation_crc
results: parsing output: 4/ for test: kms_cursor_crc
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: gem_pxp
results: parsing output: 8/ for test: syncobj_wait
results: parsing output: 9/ for test: kms_plane
results: parsing output: 10/ for test: gem_render_copy
results: parsing output: 11/ for test: kms_cursor_legacy
results: parsing output: 12/ for test: kms_flip
results: parsing output: 13/ for test: kms_dsc
results: parsing output: 14/ for test: gem_exec_fence
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: dumb_buffer
results: parsing output: 17/ for test: gem_exec_schedule
results: parsing output: 18/ for test: syncobj_wait
results: parsing output: 19/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 20/ for test: gem_exec_reloc
results: parsing output: 21/ for test: perf
results: parsing output: 22/ for test: kms_vblank
results: parsing output: 23/ for test: kms_sequence
results: parsing output: 24/ for test: kms_flip_scaled_crc
results: parsing output: 25/ for test: kms_ccs
results: parsing output: 26/ for test: gem_exec_fence
results: parsing output: 27/ for test: gem_ctx_shared
results: parsing output: 28/ for test: gem_eio
results: parsing output: 29/ for test: kms_addfb_basic
results: parsing output: 30/ for test: kms_color_pipeline
results: parsing output: 31/ for test: gem_exec_reloc
results: parsing output: 32/ for test: syncobj_timeline
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_big_fb
results: parsing output: 35/ for test: kms_flip
results: parsing output: 36/ for test: kms_atomic
results: parsing output: 37/ for test: syncobj_timeline
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: kms_ccs
results: parsing output: 40/ for test: sysfs_timeslice_duration
results: parsing output: 41/ for test: kms_big_fb
results: parsing output: 42/ for test: kms_rotation_crc
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_flip_scaled_crc
results: parsing output: 45/ for test: kms_big_fb
results: parsing output: 46/ for test: perf_pmu
results: parsing output: 47/ for test: kms_ccs
results: parsing output: 48/ for test: gem_userptr_blits
results: parsing output: 49/ for test: gem_workarounds
results: parsing output: 50/ for test: kms_invalid_mode
results: parsing output: 51/ for test: gen9_exec_parse
results: parsing output: 52/ for test: syncobj_eventfd
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_psr2_sf
results: parsing output: 56/ for test: kms_cursor_legacy
results: parsing output: 57/ for test: kms_scaling_modes
results: parsing output: 58/ for test: kms_flip
results: parsing output: 59/ for test: gem_render_copy
results: parsing output: 60/ for test: gem_exec_balancer
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_setmode
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: i915_hangman
results: parsing output: 65/ for test: api_intel_bb
results: parsing output: 66/ for test: drm_read
results: parsing output: 67/ for test: gem_exec_reloc
results: parsing output: 68/ for test: kms_ccs
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: kms_async_flips
results: parsing output: 71/ for test: kms_cursor_crc
results: parsing output: 72/ for test: kms_psr
results: parsing output: 73/ for test: kms_prime
results: parsing output: 74/ for test: gem_exec_suspend
results: parsing output: 75/ for test: kms_chamelium_hpd
results: parsing output: 76/ for test: kms_big_fb
results: parsing output: 77/ for test: kms_pm_rpm
results: parsing output: 78/ for test: drm_read
results: parsing output: 79/ for test: i915_query
results: parsing output: 80/ for test: gem_exec_schedule
results: parsing output: 81/ for test: gem_spin_batch
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_cursor_crc
results: parsing output: 84/ for test: gem_exec_schedule
results: parsing output: 85/ for test: gem_render_copy
results: parsing output: 86/ for test: gem_ctx_engines
results: parsing output: 87/ for test: syncobj_timeline
results: parsing output: 88/ for test: kms_dp_link_training
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: gem_exec_whisper
results: parsing output: 91/ for test: kms_flip_scaled_crc
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: prime_vgem
results: parsing output: 94/ for test: kms_pipe_crc_basic
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: kms_lease
results: parsing output: 97/ for test: gem_lmem_swapping
results: parsing output: 98/ for test: kms_psr
results: parsing output: 99/ for test: gem_exec_params
results: parsing output: 100/ for test: kms_cursor_legacy
results: parsing output: 101/ for test: kms_plane
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_cursor_legacy
results: parsing output: 104/ for test: gem_ctx_persistence
results: parsing output: 105/ for test: kms_big_fb
results: parsing output: 106/ for test: kms_atomic_transition
results: parsing output: 107/ for test: gem_ctx_persistence
results: parsing output: 108/ for test: kms_vrr
results: parsing output: 109/ for test: prime_vgem
results: parsing output: 110/ for test: gem_softpin
results: parsing output: 111/ for test: gem_ctx_param
results: parsing output: 112/ for test: kms_psr
results: parsing output: 113/ for test: kms_big_fb
results: parsing output: 114/ for test: kms_plane_scaling
results: parsing output: 115/ for test: gem_mmap_offset
results: parsing output: 116/ for test: gen9_exec_parse
results: parsing output: 117/ for test: kms_content_protection
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: gem_exec_schedule
results: parsing output: 121/ for test: kms_psr
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_chamelium_edid
results: parsing output: 124/ for test: kms_plane
results: parsing output: 125/ for test: prime_mmap
results: parsing output: 126/ for test: gem_basic
results: parsing output: 127/ for test: kms_chamelium_audio
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: gem_busy
results: parsing output: 130/ for test: kms_psr2_sf
results: parsing output: 131/ for test: gem_exec_params
results: parsing output: 132/ for test: i915_pm_rps
Done.