[61.847410] Initializing watchdogs
[61.847458]   /dev/watchdog0
[61.861711] [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]
[61.866542] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[61.868906] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[61.872350] [001/133] (960s left) kms_atomic_transition (plane-all-transition-nonblocking)
[62.005676] Starting subtest: plane-all-transition-nonblocking
[62.007918] Starting dynamic subtest: pipe-A-eDP-1
[64.535195] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.541s)
[64.861484] Starting dynamic subtest: pipe-B-eDP-1
[68.084423] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.243s)
[68.385865] Subtest plane-all-transition-nonblocking: SUCCESS (6.401s)
[69.235793] [002/133] (953s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc)
[69.330141] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc
[69.332417] Starting dynamic subtest: pipe-A-eDP-1
[69.354624] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[69.362185] Starting dynamic subtest: pipe-B-eDP-1
[69.384250] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[69.390679] Starting dynamic subtest: pipe-C-eDP-1
[69.412462] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[69.419070] Starting dynamic subtest: pipe-D-eDP-1
[69.441939] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[69.446079] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[71.593375] [003/133] (950s left) perf_pmu (event-wait)
[71.636611] Starting subtest: event-wait
[71.638745] Starting dynamic subtest: rcs0
[71.643157] Dynamic subtest rcs0: SKIP (0.000s)
[71.647400] Subtest event-wait: SKIP (0.000s)
[71.797133] [004/133] (950s left) syncobj_wait (multi-wait-all-submitted-signaled)
[71.865136] Starting subtest: multi-wait-all-submitted-signaled
[71.968852] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.103s)
[72.064559] [005/133] (950s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-blt)
[72.164203] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-blt
[76.630723] Subtest fbc-1p-primscrn-pri-indfb-draw-blt: SUCCESS (4.476s)
[77.783057] [006/133] (944s left) i915_drm_fdinfo (isolation)
[77.834361] Starting subtest: isolation
[77.836518] Starting dynamic subtest: rcs0
[77.870992] Dynamic subtest rcs0: SKIP (0.036s)
[77.878316] Starting dynamic subtest: bcs0
[77.882663] Dynamic subtest bcs0: SKIP (0.001s)
[77.889887] Starting dynamic subtest: vcs0
[77.893912] Dynamic subtest vcs0: SKIP (0.000s)
[77.900912] Starting dynamic subtest: vcs1
[77.905192] Dynamic subtest vcs1: SKIP (0.000s)
[77.912072] Starting dynamic subtest: vecs0
[77.916250] Dynamic subtest vecs0: SKIP (0.000s)
[77.923080] Starting dynamic subtest: ccs0
[77.927275] Dynamic subtest ccs0: SKIP (0.000s)
[77.931557] Subtest isolation: SKIP (0.040s)
[77.964179] [007/133] (944s left) kms_pm_dc (dc6-dpms)
[79.062723] Starting subtest: dc6-dpms
[81.129257] Subtest dc6-dpms: SUCCESS (2.066s)
[81.228122] [008/133] (941s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[81.327846] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[81.332301] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[81.453805] [009/133] (941s left) i915_query (query-topology-unsupported)
[81.519881] Starting subtest: query-topology-unsupported
[81.524065] Subtest query-topology-unsupported: SKIP (0.000s)
[81.627897] [010/133] (941s left) kms_atomic_transition (plane-toggle-modeset-transition)
[81.716681] Starting subtest: plane-toggle-modeset-transition
[81.718826] Starting dynamic subtest: pipe-A-eDP-1
[94.454078] Dynamic subtest pipe-A-eDP-1: SUCCESS (12.737s)
[94.463711] Starting dynamic subtest: pipe-B-eDP-1
[106.832792] Dynamic subtest pipe-B-eDP-1: SUCCESS (12.375s)
[106.835308] Subtest plane-toggle-modeset-transition: SUCCESS (25.117s)
[107.675903] [011/133] (915s left) gem_ctx_persistence (file)
[107.755835] Starting subtest: file
[107.887216] Subtest file: SUCCESS (0.134s)
[108.040917] [012/133] (914s left) i915_pm_freq_api (freq-reset)
[108.104815] Starting subtest: freq-reset
[108.107214] Starting dynamic subtest: gt0
[108.262026] Dynamic subtest gt0: SUCCESS (0.155s)
[108.269036] Starting dynamic subtest: gt1
[108.398030] Dynamic subtest gt1: SUCCESS (0.135s)
[108.400778] Subtest freq-reset: SUCCESS (0.292s)
[108.493687] [013/133] (914s left) kms_big_fb (4-tiled-16bpp-rotate-180)
[108.607590] Starting subtest: 4-tiled-16bpp-rotate-180
[109.964178] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.356s)
[110.170906] [014/133] (912s left) kms_chamelium_frames (vga-frame-dump)
[110.563541] Subtest vga-frame-dump: SKIP (0.000s)
[111.361798] [015/133] (911s left) gem_softpin (evict-active-interruptible)
[111.426516] Starting subtest: evict-active-interruptible
[111.433183] Subtest evict-active-interruptible: SUCCESS (0.007s)
[111.579129] [016/133] (911s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[111.649891] Starting subtest: single-wait-for-submit-available-signaled
[111.652233] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[111.759085] [017/133] (911s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs)
[111.860732] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs
[111.862982] Starting dynamic subtest: pipe-A-eDP-1
[111.918842] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[111.926158] Starting dynamic subtest: pipe-B-eDP-1
[111.981770] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[111.991720] Starting dynamic subtest: pipe-C-eDP-1
[112.048232] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[112.057632] Starting dynamic subtest: pipe-D-eDP-1
[112.117096] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[112.121244] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.007s)
[114.154349] [018/133] (908s left) kms_flip (flip-vs-blocking-wf-vblank)
[114.252907] Starting subtest: flip-vs-blocking-wf-vblank
[114.255318] Starting dynamic subtest: A-eDP1
[123.171859] Dynamic subtest A-eDP1: SUCCESS (8.918s)
[123.181554] Starting dynamic subtest: B-eDP1
[132.100511] Dynamic subtest B-eDP1: SUCCESS (8.928s)
[132.110618] Starting dynamic subtest: C-eDP1
[141.022368] Dynamic subtest C-eDP1: SUCCESS (8.920s)
[141.031377] Starting dynamic subtest: D-eDP1
[149.960254] Dynamic subtest D-eDP1: SUCCESS (8.937s)
[149.965994] Subtest flip-vs-blocking-wf-vblank: SUCCESS (35.713s)
[151.200105] [019/133] (871s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt)
[151.297932] Starting subtest: fbcpsr-rgb101010-draw-blt
[158.057765] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (6.763s)
[158.217440] [020/133] (864s left) gem_exec_schedule (semaphore-codependency)
[158.285729] Starting subtest: semaphore-codependency
[158.287670] Subtest semaphore-codependency: SUCCESS (0.011s)
[158.661384] [021/133] (864s left) sriov_basic (enable-vfs-autoprobe-off)
[158.717938] Starting subtest: enable-vfs-autoprobe-off
[158.720553] Starting dynamic subtest: numvfs-1
[158.799992] Dynamic subtest numvfs-1: FAIL (0.032s)
[158.807656] Starting dynamic subtest: numvfs-2
[158.879789] Dynamic subtest numvfs-2: FAIL (0.004s)
[158.888556] Starting dynamic subtest: numvfs-3
[158.961128] Dynamic subtest numvfs-3: FAIL (0.004s)
[158.970108] Starting dynamic subtest: numvfs-4
[159.043721] Dynamic subtest numvfs-4: FAIL (0.003s)
[159.053238] Starting dynamic subtest: numvfs-5
[159.125538] Dynamic subtest numvfs-5: FAIL (0.004s)
[159.134055] Starting dynamic subtest: numvfs-6
[159.206277] Dynamic subtest numvfs-6: FAIL (0.003s)
[159.215078] Starting dynamic subtest: numvfs-7
[159.287680] Dynamic subtest numvfs-7: FAIL (0.004s)
[159.296645] Starting dynamic subtest: numvfs-random
[159.368893] Dynamic subtest numvfs-random: FAIL (0.004s)
[159.378367] Starting dynamic subtest: numvfs-all
[159.452623] Dynamic subtest numvfs-all: FAIL (0.501s)
[159.454629] Subtest enable-vfs-autoprobe-off: FAIL (0.563s)
[159.490123] [022/133] (863s left) syncobj_timeline (wait-any-complex)
[159.553497] Starting subtest: wait-any-complex
[159.614870] Subtest wait-any-complex: SUCCESS (0.061s)
[159.712524] [023/133] (863s left) prime_mmap (test_aperture_limit)
[159.777626] Starting subtest: test_aperture_limit
[159.779570] Starting dynamic subtest: test_aperture_limit-smem
[159.785896] Dynamic subtest test_aperture_limit-smem: SKIP (0.008s)
[159.789436] Subtest test_aperture_limit: SKIP (0.008s)
[159.912356] [024/133] (863s left) kms_invalid_mode (zero-hdisplay)
[159.998047] Starting subtest: zero-hdisplay
[159.999869] Starting dynamic subtest: pipe-A-eDP-1
[160.287621] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.291s)
[160.295693] Starting dynamic subtest: pipe-B-eDP-1
[160.297660] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[160.304480] Starting dynamic subtest: pipe-C-eDP-1
[160.306395] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[160.313812] Starting dynamic subtest: pipe-D-eDP-1
[160.316073] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[160.318243] Subtest zero-hdisplay: SUCCESS (0.296s)
[161.155583] [025/133] (862s left) kms_big_fb (x-tiled-8bpp-rotate-270)
[161.265293] Starting subtest: x-tiled-8bpp-rotate-270
[161.286169] Subtest x-tiled-8bpp-rotate-270: SKIP (0.021s)
[161.433396] [026/133] (861s left) gem_vm_create (isolation)
[161.508292] Starting subtest: isolation
[161.517596] Subtest isolation: SUCCESS (0.009s)
[161.696609] [027/133] (861s left) kms_cursor_crc (cursor-tearing-framebuffer-change)
[161.811506] Starting subtest: cursor-tearing-framebuffer-change
[161.813774] Starting dynamic subtest: pipe-A-eDP-1
[162.378627] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.563s)
[162.387675] Starting dynamic subtest: pipe-D-eDP-1
[163.666297] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.289s)
[163.668646] Subtest cursor-tearing-framebuffer-change: SUCCESS (1.854s)
[164.530642] [028/133] (858s left) kms_plane_cursor (primary)
[164.639962] Starting subtest: primary
[164.644140] Starting dynamic subtest: pipe-A-eDP-1-size-64
[167.225478] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.586s)
[167.248741] Starting dynamic subtest: pipe-A-eDP-1-size-128
[169.826732] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.582s)
[169.852508] Starting dynamic subtest: pipe-A-eDP-1-size-256
[172.471975] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.625s)
[172.787293] Starting dynamic subtest: pipe-B-eDP-1-size-64
[176.124613] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.345s)
[176.146698] Starting dynamic subtest: pipe-B-eDP-1-size-128
[178.748519] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.607s)
[178.771347] Starting dynamic subtest: pipe-B-eDP-1-size-256
[181.327055] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.559s)
[181.645817] Starting dynamic subtest: pipe-C-eDP-1-size-64
[184.595445] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.960s)
[184.620274] Starting dynamic subtest: pipe-C-eDP-1-size-128
[186.774105] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.158s)
[186.798466] Starting dynamic subtest: pipe-C-eDP-1-size-256
[188.995405] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.202s)
[189.310101] Starting dynamic subtest: pipe-D-eDP-1-size-64
[192.186249] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.884s)
[192.212490] Starting dynamic subtest: pipe-D-eDP-1-size-128
[194.398496] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.191s)
[194.422441] Starting dynamic subtest: pipe-D-eDP-1-size-256
[196.608360] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.191s)
[196.918573] Subtest primary: SUCCESS (32.278s)
[197.752257] [029/133] (825s left) syncobj_wait (invalid-single-wait-all-unsubmitted)
[197.821547] Starting subtest: invalid-single-wait-all-unsubmitted
[197.823809] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s)
[197.947388] [030/133] (825s left) kms_chamelium_audio (hdmi-audio-edid)
[198.336059] Subtest hdmi-audio-edid: SKIP (0.000s)
[199.142645] [031/133] (824s left) gem_mmap_wc (copy)
[199.212967] Subtest copy: SKIP (0.000s)
[199.282112] [032/133] (824s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[199.393079] Starting subtest: y-tiled-64bpp-rotate-270
[199.396946] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[199.524267] [033/133] (824s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-cpu)
[199.633043] Starting subtest: psr-rgb565-draw-mmap-cpu
[206.554166] Subtest psr-rgb565-draw-mmap-cpu: SUCCESS (6.922s)
[206.676417] [034/133] (816s left) kms_busy (basic)
[206.770711] Starting subtest: basic
[206.772981] Starting dynamic subtest: flip
[207.364092] Dynamic subtest flip: SUCCESS (0.592s)
[207.372717] Starting dynamic subtest: modeset
[210.796330] Dynamic subtest modeset: SUCCESS (3.432s)
[210.798540] Subtest basic: SUCCESS (4.025s)
[211.610876] [035/133] (812s left) kms_content_protection (dp-mst-type-0)
[211.751892] Starting subtest: dp-mst-type-0
[211.756516] Subtest dp-mst-type-0: SKIP (0.000s)
[211.920817] [036/133] (811s left) gem_exec_whisper (basic-forked-all)
[212.002382] Starting subtest: basic-forked-all
[225.211953] Subtest basic-forked-all: SUCCESS (13.210s)
[225.423423] [037/133] (798s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-gtt)
[225.531703] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-gtt
[225.536915] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[225.635853] [038/133] (798s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[225.733630] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[225.737793] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[225.849552] [039/133] (797s left) kms_rotation_crc (primary-rotation-270)
[225.946943] Starting subtest: primary-rotation-270
[225.951417] Subtest primary-rotation-270: SKIP (0.001s)
[226.041346] [040/133] (797s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-pwrite)
[226.138080] Starting subtest: psr-1p-offscreen-pri-indfb-draw-pwrite
[233.217214] Subtest psr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.081s)
[233.364525] [041/133] (790s left) perf (oa-formats)
[233.512276] Starting subtest: oa-formats
[233.514414] Starting dynamic subtest: 0-rcs0
[233.527667] Dynamic subtest 0-rcs0: SUCCESS (0.016s)
[233.536488] Starting dynamic subtest: 1-vcs1
[233.549062] Dynamic subtest 1-vcs1: SUCCESS (0.021s)
[233.551361] Subtest oa-formats: SUCCESS (0.039s)
[233.611525] [042/133] (790s left) kms_properties (crtc-properties-atomic)
[233.699221] Starting subtest: crtc-properties-atomic
[233.701195] Starting dynamic subtest: pipe-A-eDP-1
[234.149980] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.451s)
[234.159106] Starting dynamic subtest: pipe-B-eDP-1
[235.285315] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.134s)
[235.294236] Starting dynamic subtest: pipe-C-eDP-1
[236.410956] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.124s)
[236.424075] Starting dynamic subtest: pipe-D-eDP-1
[237.537072] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.124s)
[237.539370] Subtest crtc-properties-atomic: SUCCESS (3.840s)
[238.375218] [043/133] (785s left) gem_ctx_isolation (dirty-create)
[238.442025] Starting subtest: dirty-create
[238.443941] Starting dynamic subtest: rcs0
[238.625025] Dynamic subtest rcs0: SUCCESS (0.185s)
[238.635163] Starting dynamic subtest: bcs0
[238.816692] Dynamic subtest bcs0: SUCCESS (0.191s)
[238.827021] Starting dynamic subtest: vcs0
[239.051043] Dynamic subtest vcs0: SUCCESS (0.233s)
[239.060382] Starting dynamic subtest: vcs1
[241.130416] Dynamic subtest vcs1: SUCCESS (2.078s)
[241.140404] Starting dynamic subtest: vecs0
[243.135473] Dynamic subtest vecs0: SUCCESS (2.004s)
[243.143684] Starting dynamic subtest: ccs0
[245.122474] Dynamic subtest ccs0: SUCCESS (1.986s)
[245.124843] Subtest dirty-create: SUCCESS (6.683s)
[245.408190] [044/133] (778s left) kms_cursor_legacy (cursora-vs-flipa-legacy)
[245.536728] Starting subtest: cursorA-vs-flipA-legacy
[256.663612] Subtest cursorA-vs-flipA-legacy: SUCCESS (11.125s)
[257.504418] [045/133] (766s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[257.607145] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[257.611231] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[257.727309] [046/133] (766s left) kms_frontbuffer_tracking (fbcpsr-2p-rte)
[257.823430] Starting subtest: fbcpsr-2p-rte
[257.827339] Subtest fbcpsr-2p-rte: SKIP (0.000s)
[257.954369] [047/133] (766s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling)
[258.054175] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling
[258.056496] Starting dynamic subtest: pipe-A-default-mode
[260.822885] Dynamic subtest pipe-A-default-mode: SUCCESS (2.768s)
[260.825140] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SUCCESS (2.770s)
[261.682495] [048/133] (762s left) kms_psr (fbc-psr2-sprite-plane-onoff)
[261.780142] Starting subtest: fbc-psr2-sprite-plane-onoff
[261.782411] Starting dynamic subtest: eDP-1
[261.786754] Dynamic subtest eDP-1: SKIP (0.000s)
[261.791167] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.001s)
[261.875806] [049/133] (762s left) syncobj_timeline (invalid-wait-bad-flags)
[261.945045] Starting subtest: invalid-wait-bad-flags
[261.947550] Subtest invalid-wait-bad-flags: SUCCESS (0.000s)
[262.100851] [050/133] (762s left) fbdev (read)
[262.148857] Starting subtest: read
[262.680846] Subtest read: SUCCESS (0.530s)
[262.765355] [051/133] (761s left) gem_mmap_offset (blt-coherency)
[262.819783] Starting subtest: blt-coherency
[262.825939] Subtest blt-coherency: SUCCESS (0.009s)
[262.976618] [052/133] (761s left) vgem_basic (dmabuf-export)
[263.069205] Starting subtest: dmabuf-export
[263.092271] Subtest dmabuf-export: SUCCESS (0.024s)
[263.216213] [FACT vgem_basic (dmabuf-export)] new: kernel.kmod_is_loaded.vgem: true
[263.220057] [053/133] (761s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[263.265423] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[263.267341] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[263.388103] [054/133] (761s left) gem_mmap_gtt (cpuset-medium-copy-odd)
[263.462197] Subtest cpuset-medium-copy-odd: SKIP (0.000s)
[263.524609] [055/133] (760s left) gem_create (create-clear)
[263.583720] Starting subtest: create-clear
[263.585665] Starting dynamic subtest: smem0
[296.410597] Dynamic subtest smem0: SUCCESS (32.823s)
[296.412849] Subtest create-clear: SUCCESS (32.824s)
[296.622689] [056/133] (727s left) gem_exec_balancer (bonded-sync)
[296.698868] Starting subtest: bonded-sync
[296.703546] Subtest bonded-sync: SKIP (0.000s)
[297.035962] [057/133] (727s left) i915_suspend (debugfs-reader)
[297.095918] Starting subtest: debugfs-reader
[315.031346] Subtest debugfs-reader: SUCCESS (3.279s)
[315.129848] [058/133] (709s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[315.208113] Starting subtest: x-tiled-to-vebox-y-tiled
[315.212063] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[315.409301] [059/133] (709s left) prime_mmap (test_userptr)
[315.478327] Starting subtest: test_userptr
[315.480609] Starting dynamic subtest: test_userptr-smem
[315.482519] Dynamic subtest test_userptr-smem: SUCCESS (0.000s)
[315.484458] Subtest test_userptr: SUCCESS (0.001s)
[315.603754] [060/133] (709s left) gem_userptr_blits (forbidden-operations)
[315.670173] Starting subtest: forbidden-operations
[315.674604] Subtest forbidden-operations: SKIP (0.000s)
[315.836633] [061/133] (708s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[315.958720] Starting subtest: cursorA-vs-flipA-toggle
[326.945783] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.158s)
[327.766637] [062/133] (696s left) i915_pm_rpm (reg-read-ioctl)
[329.690275] Starting subtest: reg-read-ioctl
[331.974271] Subtest reg-read-ioctl: SUCCESS (2.293s)
[332.376459] [063/133] (692s left) i915_query (query-topology-kernel-writes)
[332.436830] Starting subtest: query-topology-kernel-writes
[332.438986] Subtest query-topology-kernel-writes: SUCCESS (0.000s)
[332.557816] [064/133] (692s left) kms_frontbuffer_tracking (psr-rgb565-draw-pwrite)
[332.656343] Starting subtest: psr-rgb565-draw-pwrite
[339.772862] Subtest psr-rgb565-draw-pwrite: SUCCESS (7.136s)
[339.913493] [065/133] (684s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[340.021635] Starting subtest: compare-crc-sanitycheck-nv12
[340.023855] Starting dynamic subtest: pipe-A-eDP-1
[340.712754] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.691s)
[340.722526] Starting dynamic subtest: pipe-B-eDP-1
[341.988698] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.276s)
[341.998348] Starting dynamic subtest: pipe-C-eDP-1
[343.256055] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.270s)
[343.267726] Starting dynamic subtest: pipe-D-eDP-1
[344.469379] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.212s)
[344.471737] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.455s)
[345.329440] [066/133] (679s left) api_intel_allocator (open-vm)
[345.392504] Starting subtest: open-vm
[345.394793] Subtest open-vm: SUCCESS (0.003s)
[345.560778] [067/133] (679s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[345.662297] Starting subtest: fbc-pr-cursor-mmap-cpu
[345.666796] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[345.758376] [068/133] (679s left) gem_mmap_gtt (basic-write-read)
[345.828454] Subtest basic-write-read: SKIP (0.000s)
[345.897021] [069/133] (679s left) kms_hdr (bpc-switch-dpms)
[345.994734] Starting subtest: bpc-switch-dpms
[347.081063] Starting dynamic subtest: pipe-A-eDP-1
[351.596924] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.517s)
[351.599238] Subtest bpc-switch-dpms: SUCCESS (5.603s)
[351.745809] [070/133] (673s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[351.801916] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[351.909047] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.106s)
[352.010210] [071/133] (673s left) kms_prop_blob (invalid-set-prop-any)
[352.069111] Starting subtest: invalid-set-prop-any
[352.070981] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[352.197914] [072/133] (672s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[352.301119] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt
[352.305394] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[352.437511] [073/133] (672s left) kms_plane (pixel-format)
[352.533937] Starting subtest: pixel-format
[352.559366] Starting dynamic subtest: pipe-A-plane-0
[357.292217] Dynamic subtest pipe-A-plane-0: SUCCESS (4.733s)
[357.301196] Starting dynamic subtest: pipe-A-plane-3
[359.504477] Dynamic subtest pipe-A-plane-3: SUCCESS (2.209s)
[359.514726] Starting dynamic subtest: pipe-A-plane-5
[359.714804] Dynamic subtest pipe-A-plane-5: SUCCESS (0.210s)
[360.836935] Starting dynamic subtest: pipe-B-plane-0
[365.650976] Dynamic subtest pipe-B-plane-0: SUCCESS (4.822s)
[365.660541] Starting dynamic subtest: pipe-B-plane-3
[367.928695] Dynamic subtest pipe-B-plane-3: SUCCESS (2.277s)
[367.938780] Starting dynamic subtest: pipe-B-plane-5
[368.139668] Dynamic subtest pipe-B-plane-5: SUCCESS (0.210s)
[368.454503] Subtest pixel-format: SUCCESS (15.921s)
[369.333728] [074/133] (655s left) kms_feature_discovery (psr1)
[369.436802] Starting subtest: psr1
[369.439035] Subtest psr1: SUCCESS (0.000s)
[369.535616] [075/133] (655s left) kms_cursor_legacy (single-move)
[369.672464] Starting subtest: single-move
[369.674623] Starting dynamic subtest: pipe-A
[375.053754] Dynamic subtest pipe-A: SUCCESS (5.379s)
[375.065022] Starting dynamic subtest: pipe-B
[380.435645] Dynamic subtest pipe-B: SUCCESS (5.380s)
[380.446474] Starting dynamic subtest: pipe-C
[385.816651] Dynamic subtest pipe-C: SUCCESS (5.380s)
[385.827825] Starting dynamic subtest: pipe-D
[391.196483] Dynamic subtest pipe-D: SUCCESS (5.379s)
[391.207236] Starting dynamic subtest: all-pipes
[396.582956] Dynamic subtest all-pipes: SUCCESS (5.386s)
[396.585453] Subtest single-move: SUCCESS (26.917s)
[396.752208] [076/133] (628s left) kms_big_fb (linear-32bpp-rotate-0)
[396.858802] Starting subtest: linear-32bpp-rotate-0
[398.359741] Subtest linear-32bpp-rotate-0: SUCCESS (1.502s)
[398.537375] [077/133] (626s left) gem_exec_fence (syncobj-stationary-timeline-chain-engines)
[399.100267] Starting subtest: syncobj-stationary-timeline-chain-engines
[399.200912] Subtest syncobj-stationary-timeline-chain-engines: SUCCESS (0.102s)
[400.750904] [078/133] (624s left) gem_exec_fence (syncobj-timeline-wait)
[401.284213] Starting subtest: syncobj-timeline-wait
[402.640811] Subtest syncobj-timeline-wait: SUCCESS (1.357s)
[404.680767] [079/133] (620s left) kms_psr (psr-primary-blt)
[404.775266] Starting subtest: psr-primary-blt
[404.777609] Starting dynamic subtest: eDP-1
[406.492463] Dynamic subtest eDP-1: SUCCESS (1.716s)
[406.494627] Subtest psr-primary-blt: SUCCESS (1.717s)
[407.387459] [080/133] (618s left) gem_softpin (noreloc-interruptible)
[407.459343] Starting subtest: noreloc-interruptible
[412.854002] Subtest noreloc-interruptible: SUCCESS (5.395s)
[413.013232] [081/133] (612s left) api_intel_bb (reset-bb)
[413.068118] Starting subtest: reset-bb
[413.073021] Subtest reset-bb: SUCCESS (0.006s)
[413.228219] [082/133] (612s left) gem_render_copy (y-tiled-to-vebox-y-tiled)
[413.291683] Starting subtest: y-tiled-to-vebox-y-tiled
[413.296310] Subtest y-tiled-to-vebox-y-tiled: SKIP (0.000s)
[413.501770] [083/133] (612s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff)
[413.616447] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff
[413.620567] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[413.749077] [084/133] (611s left) gem_exec_balancer (persistence)
[414.024527] Starting subtest: persistence
[414.928736] Subtest persistence: SUCCESS (0.904s)
[415.085551] [085/133] (610s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[415.194191] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[415.807106] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.614s)
[415.982175] [086/133] (609s left) gem_mmap_gtt (basic-small-bo-tiledx)
[416.049939] Subtest basic-small-bo-tiledX: SKIP (0.000s)
[416.126883] [087/133] (609s left) gem_ctx_shared (disjoint-timelines)
[416.201303] Starting subtest: disjoint-timelines
[416.231285] Subtest disjoint-timelines: SUCCESS (0.029s)
[416.523358] [088/133] (609s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt)
[416.627502] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt
[416.632016] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[416.776998] [089/133] (609s left) gem_userptr_blits (map-fixed-invalidate-busy)
[416.849776] Starting subtest: map-fixed-invalidate-busy
[416.854723] Subtest map-fixed-invalidate-busy: SKIP (0.000s)
[417.025342] [090/133] (608s left) perf_pmu (semaphore-wait)
[417.063736] Starting subtest: semaphore-wait
[417.066089] Starting dynamic subtest: rcs0
[417.580771] Dynamic subtest rcs0: SUCCESS (0.515s)
[417.593578] Starting dynamic subtest: bcs0
[418.094004] Dynamic subtest bcs0: SUCCESS (0.510s)
[418.106590] Starting dynamic subtest: vcs0
[418.607063] Dynamic subtest vcs0: SUCCESS (0.510s)
[418.617884] Starting dynamic subtest: vcs1
[419.120404] Dynamic subtest vcs1: SUCCESS (0.510s)
[419.132647] Starting dynamic subtest: vecs0
[419.634021] Dynamic subtest vecs0: SUCCESS (0.510s)
[419.646457] Starting dynamic subtest: ccs0
[420.150645] Dynamic subtest ccs0: SUCCESS (0.514s)
[420.153724] Subtest semaphore-wait: SUCCESS (3.086s)
[421.648497] [091/133] (604s left) dmabuf_sync_file (import-multiple-read-write)
[421.697445] Starting subtest: import-multiple-read-write
[421.699680] Subtest import-multiple-read-write: SUCCESS (0.003s)
[421.777680] [092/133] (604s left) gem_exec_params (rel-constants-invalid-ring)
[421.842012] Starting subtest: rel-constants-invalid-ring
[421.844236] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[421.981377] [093/133] (604s left) kms_psr2_sf (fbc-psr2-overlay-primary-update-sf-dmg-area)
[427.041585] Starting subtest: fbc-psr2-overlay-primary-update-sf-dmg-area
[427.043834] Starting dynamic subtest: pipe-A-eDP-1
[427.841105] Dynamic subtest pipe-A-eDP-1: SKIP (0.795s)
[427.851059] Starting dynamic subtest: pipe-B-eDP-1
[429.072670] Dynamic subtest pipe-B-eDP-1: SKIP (1.230s)
[429.077008] Subtest fbc-psr2-overlay-primary-update-sf-dmg-area: SKIP (2.030s)
[430.278278] [094/133] (595s left) gem_ctx_param (invalid-param-set)
[430.345230] Starting subtest: invalid-param-set
[430.347570] Subtest invalid-param-set: SUCCESS (0.000s)
[430.444688] [095/133] (595s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-mmap-cpu)
[430.541847] Starting subtest: fbcpsr-argb161616f-draw-mmap-cpu
[430.545969] Subtest fbcpsr-argb161616f-draw-mmap-cpu: SKIP (0.000s)
[430.682641] [096/133] (595s left) kms_cursor_legacy (cursorb-vs-flipb-varying-size)
[430.805090] Starting subtest: cursorB-vs-flipB-varying-size
[430.809392] Subtest cursorB-vs-flipB-varying-size: SKIP (0.001s)
[430.977528] [097/133] (595s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-wc)
[431.104683] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-wc
[431.109081] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[431.249672] [098/133] (595s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[431.359117] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[434.961885] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.606s)
[436.188171] [099/133] (590s left) gem_userptr_blits (stress-mm-invalidate-close)
[436.258318] Starting subtest: stress-mm-invalidate-close
[438.407091] Subtest stress-mm-invalidate-close: SUCCESS (2.148s)
[438.573357] [100/133] (587s left) kms_cursor_crc (cursor-onscreen-512x512)
[438.840739] Starting subtest: cursor-onscreen-512x512
[438.844906] Subtest cursor-onscreen-512x512: SKIP (0.001s)
[439.043421] [101/133] (587s left) kms_color (ctm-negative)
[439.148964] Starting subtest: ctm-negative
[439.150775] Starting dynamic subtest: pipe-A-eDP-1
[439.857580] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.709s)
[439.871698] Starting dynamic subtest: pipe-B-eDP-1
[441.269753] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.411s)
[441.288258] Starting dynamic subtest: pipe-C-eDP-1
[442.652542] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.381s)
[442.661939] Starting dynamic subtest: pipe-D-eDP-1
[443.977478] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.324s)
[443.979818] Subtest ctm-negative: SUCCESS (4.829s)
[444.803417] [102/133] (581s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[444.911101] Starting subtest: yf-tiled-8bpp-rotate-270
[444.915523] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[445.036474] [103/133] (581s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[445.132813] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s)
[445.262743] [104/133] (581s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-mc-ccs)
[445.362863] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-mc-ccs
[445.365090] Starting dynamic subtest: pipe-A-eDP-1
[445.388007] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[445.404260] Starting dynamic subtest: pipe-B-eDP-1
[445.426610] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[445.437379] Starting dynamic subtest: pipe-C-eDP-1
[445.459734] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[445.470532] Starting dynamic subtest: pipe-D-eDP-1
[445.492820] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[445.497112] Subtest crc-primary-rotation-180-4-tiled-dg2-mc-ccs: SKIP (0.006s)
[447.582798] [105/133] (578s left) gem_spin_batch (spin-each)
[447.643043] Starting subtest: spin-each
[450.994921] Subtest spin-each: SUCCESS (3.354s)
[451.686215] [106/133] (574s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[451.842786] Starting subtest: cursor-rapid-movement-32x10
[451.890304] Subtest cursor-rapid-movement-32x10: SKIP (0.043s)
[452.177429] [107/133] (574s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[452.289217] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[459.355070] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.068s)
[459.492408] [108/133] (567s left) kms_psr (pr-cursor-mmap-gtt)
[459.594855] Starting subtest: pr-cursor-mmap-gtt
[459.599740] Subtest pr-cursor-mmap-gtt: SKIP (0.000s)
[459.691881] [109/133] (567s left) perf (missing-sample-flags)
[459.790164] Starting subtest: missing-sample-flags
[459.792557] Subtest missing-sample-flags: SUCCESS (0.000s)
[459.830577] [110/133] (566s left) kms_vblank (ts-continuation-modeset-hang)
[459.928141] Starting subtest: ts-continuation-modeset-hang
[459.930520] Starting dynamic subtest: pipe-A-eDP-1
[486.321384] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.397s)
[486.336022] Starting dynamic subtest: pipe-D-eDP-1
[511.358690] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.038s)
[511.360678] Subtest ts-continuation-modeset-hang: SUCCESS (51.440s)
[512.236823] [111/133] (514s left) perf (gen12-mi-rpc)
[512.342628] Starting subtest: gen12-mi-rpc
[512.345150] Starting dynamic subtest: rcs0
[512.365034] Dynamic subtest rcs0: SUCCESS (0.019s)
[512.367249] Subtest gen12-mi-rpc: SUCCESS (0.020s)
[512.413438] [112/133] (514s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[512.553919] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu
[519.120893] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.571s)
[519.308951] [113/133] (507s left) gem_lmem_swapping (parallel-multi)
[519.365817] Subtest parallel-multi: SKIP (0.000s)
[519.449456] [114/133] (507s left) kms_flip (2x-absolute-wf_vblank-interruptible)
[519.577668] Starting subtest: 2x-absolute-wf_vblank-interruptible
[519.590982] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.011s)
[519.694025] [115/133] (507s left) gen9_exec_parse (bb-oversize)
[519.747443] Subtest bb-oversize: SKIP (0.000s)
[519.829902] [116/133] (507s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[519.921237] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[520.712060] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.792s)
[520.894049] [117/133] (506s left) gem_mmap_wc (write-wc-read-gtt)
[520.959070] Subtest write-wc-read-gtt: SKIP (0.000s)
[521.015036] [118/133] (506s left) kms_psr (fbc-pr-primary-mmap-gtt)
[521.105930] Starting subtest: fbc-pr-primary-mmap-gtt
[521.110132] Subtest fbc-pr-primary-mmap-gtt: SKIP (0.000s)
[521.202962] [119/133] (506s left) kms_sequence (get-forked-busy)
[521.295740] Starting subtest: get-forked-busy
[521.298005] Starting dynamic subtest: pipe-A-eDP-1
[523.231860] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.937s)
[523.241340] Starting dynamic subtest: pipe-B-eDP-1
[525.841856] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.609s)
[525.855922] Starting dynamic subtest: pipe-C-eDP-1
[528.455617] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.610s)
[528.466036] Starting dynamic subtest: pipe-D-eDP-1
[530.995438] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.541s)
[530.997643] Subtest get-forked-busy: SUCCESS (9.702s)
[531.904229] [120/133] (495s left) kms_psr (psr2-sprite-mmap-cpu)
[531.994829] Starting subtest: psr2-sprite-mmap-cpu
[531.996939] Starting dynamic subtest: eDP-1
[533.688303] Dynamic subtest eDP-1: SUCCESS (1.693s)
[533.690588] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.694s)
[534.582836] [121/133] (492s left) sw_sync (sync_random_merge)
[534.620958] Starting subtest: sync_random_merge
[534.660803] Subtest sync_random_merge: SUCCESS (0.041s)
[534.745517] [122/133] (492s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy)
[534.863091] Starting subtest: 2x-long-flip-vs-cursor-legacy
[534.867422] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s)
[535.033870] [123/133] (492s left) syncobj_wait (single-wait-all-for-submit-submitted)
[535.091516] Starting subtest: single-wait-all-for-submit-submitted
[535.196766] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.105s)
[535.300349] [124/133] (492s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc)
[535.390966] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc
[535.393263] Starting dynamic subtest: pipe-A-eDP-1
[535.415645] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[535.428386] Starting dynamic subtest: pipe-B-eDP-1
[535.450014] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[535.459004] Starting dynamic subtest: pipe-C-eDP-1
[535.481083] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[535.490012] Starting dynamic subtest: pipe-D-eDP-1
[535.512152] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[535.516176] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[537.581361] [125/133] (489s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[537.674935] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[537.677262] Starting dynamic subtest: pipe-A-default-mode
[540.403595] Dynamic subtest pipe-A-default-mode: SUCCESS (2.728s)
[540.406022] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (2.729s)
[541.266510] [126/133] (486s left) gem_exec_schedule (pi-userfault)
[541.458447] Starting subtest: pi-userfault
[541.460649] Starting dynamic subtest: rcs0
[541.467767] Dynamic subtest rcs0: SUCCESS (0.011s)
[541.477934] Starting dynamic subtest: bcs0
[541.480530] Dynamic subtest bcs0: SUCCESS (0.009s)
[541.490239] Starting dynamic subtest: vcs0
[541.492201] Dynamic subtest vcs0: SUCCESS (0.008s)
[541.501406] Starting dynamic subtest: vcs1
[541.503610] Dynamic subtest vcs1: SUCCESS (0.008s)
[541.513397] Starting dynamic subtest: vecs0
[541.515624] Dynamic subtest vecs0: SUCCESS (0.008s)
[541.524656] Starting dynamic subtest: ccs0
[541.526814] Dynamic subtest ccs0: SUCCESS (0.007s)
[541.529013] Subtest pi-userfault: SUCCESS (0.054s)
[541.718337] [127/133] (485s left) prime_mmap_coherency (read)
[541.783538] Starting subtest: read
[547.160286] Subtest read: SUCCESS (5.373s)
[547.305158] [128/133] (480s left) kms_pm_rpm (fences)
[548.838219] Starting subtest: fences
[548.843210] Subtest fences: SKIP (0.000s)
[549.595372] [129/133] (478s left) kms_chamelium_frames (hdmi-frame-dump)
[549.996367] Subtest hdmi-frame-dump: SKIP (0.000s)
[550.778290] [130/133] (476s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[550.874639] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[550.878670] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[550.996392] [131/133] (476s left) kms_frontbuffer_tracking (fbc-argb161616f-draw-mmap-gtt)
[551.100245] Starting subtest: fbc-argb161616f-draw-mmap-gtt
[551.104623] Subtest fbc-argb161616f-draw-mmap-gtt: SKIP (0.000s)
[551.226855] [132/133] (476s left) gem_mmap_gtt (big-bo)
[551.291391] Subtest big-bo: SKIP (0.000s)
[551.359374] [133/133] (476s left) kms_plane_scaling (planes-upscale-20x20)
[551.459109] Starting subtest: planes-upscale-20x20
[551.461420] Starting dynamic subtest: pipe-A
[551.518632] Dynamic subtest pipe-A: SUCCESS (0.062s)
[551.528337] Starting dynamic subtest: pipe-B
[552.622580] Dynamic subtest pipe-B: SUCCESS (1.101s)
[552.633838] Starting dynamic subtest: pipe-C
[553.731311] Dynamic subtest pipe-C: SUCCESS (1.108s)
[553.746884] Starting dynamic subtest: pipe-D
[554.863959] Dynamic subtest pipe-D: SUCCESS (1.130s)
[554.866152] Subtest planes-upscale-20x20: SUCCESS (3.407s)
[556.045917] Closing watchdogs
results: parsing output: 0/ for test: kms_atomic_transition
results: parsing output: 1/ for test: kms_ccs
results: parsing output: 2/ for test: perf_pmu
results: parsing output: 3/ for test: syncobj_wait
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: i915_drm_fdinfo
results: parsing output: 6/ for test: kms_pm_dc
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: i915_query
results: parsing output: 9/ for test: kms_atomic_transition
results: parsing output: 10/ for test: gem_ctx_persistence
results: parsing output: 11/ for test: i915_pm_freq_api
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: kms_chamelium_frames
results: parsing output: 14/ for test: gem_softpin
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: kms_ccs
results: parsing output: 17/ for test: kms_flip
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: gem_exec_schedule
results: parsing output: 20/ for test: sriov_basic
results: parsing output: 21/ for test: syncobj_timeline
results: parsing output: 22/ for test: prime_mmap
results: parsing output: 23/ for test: kms_invalid_mode
results: parsing output: 24/ for test: kms_big_fb
results: parsing output: 25/ for test: gem_vm_create
results: parsing output: 26/ for test: kms_cursor_crc
results: parsing output: 27/ for test: kms_plane_cursor
results: parsing output: 28/ for test: syncobj_wait
results: parsing output: 29/ for test: kms_chamelium_audio
results: parsing output: 30/ for test: gem_mmap_wc
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_busy
results: parsing output: 34/ for test: kms_content_protection
results: parsing output: 35/ for test: gem_exec_whisper
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_rotation_crc
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: perf
results: parsing output: 41/ for test: kms_properties
results: parsing output: 42/ for test: gem_ctx_isolation
results: parsing output: 43/ for test: kms_cursor_legacy
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_flip_scaled_crc
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: syncobj_timeline
results: parsing output: 49/ for test: fbdev
results: parsing output: 50/ for test: gem_mmap_offset
results: parsing output: 51/ for test: vgem_basic
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: gem_mmap_gtt
results: parsing output: 54/ for test: gem_create
results: parsing output: 55/ for test: gem_exec_balancer
results: parsing output: 56/ for test: i915_suspend
results: parsing output: 57/ for test: gem_render_copy
results: parsing output: 58/ for test: prime_mmap
results: parsing output: 59/ for test: gem_userptr_blits
results: parsing output: 60/ for test: kms_cursor_legacy
results: parsing output: 61/ for test: i915_pm_rpm
results: parsing output: 62/ for test: i915_query
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_pipe_crc_basic
results: parsing output: 65/ for test: api_intel_allocator
results: parsing output: 66/ for test: kms_psr
results: parsing output: 67/ for test: gem_mmap_gtt
results: parsing output: 68/ for test: kms_hdr
results: parsing output: 69/ for test: syncobj_timeline
results: parsing output: 70/ for test: kms_prop_blob
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_plane
results: parsing output: 73/ for test: kms_feature_discovery
results: parsing output: 74/ for test: kms_cursor_legacy
results: parsing output: 75/ for test: kms_big_fb
results: parsing output: 76/ for test: gem_exec_fence
results: parsing output: 77/ for test: gem_exec_fence
results: parsing output: 78/ for test: kms_psr
results: parsing output: 79/ for test: gem_softpin
results: parsing output: 80/ for test: api_intel_bb
results: parsing output: 81/ for test: gem_render_copy
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: gem_exec_balancer
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: gem_mmap_gtt
results: parsing output: 86/ for test: gem_ctx_shared
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: gem_userptr_blits
results: parsing output: 89/ for test: perf_pmu
results: parsing output: 90/ for test: dmabuf_sync_file
results: parsing output: 91/ for test: gem_exec_params
results: parsing output: 92/ for test: kms_psr2_sf
results: parsing output: 93/ for test: gem_ctx_param
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_cursor_legacy
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: gem_userptr_blits
results: parsing output: 99/ for test: kms_cursor_crc
results: parsing output: 100/ for test: kms_color
results: parsing output: 101/ for test: kms_big_fb
results: parsing output: 102/ for test: kms_addfb_basic
results: parsing output: 103/ for test: kms_ccs
results: parsing output: 104/ for test: gem_spin_batch
results: parsing output: 105/ for test: kms_cursor_crc
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_psr
results: parsing output: 108/ for test: perf
results: parsing output: 109/ for test: kms_vblank
results: parsing output: 110/ for test: perf
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: gem_lmem_swapping
results: parsing output: 113/ for test: kms_flip
results: parsing output: 114/ for test: gen9_exec_parse
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: gem_mmap_wc
results: parsing output: 117/ for test: kms_psr
results: parsing output: 118/ for test: kms_sequence
results: parsing output: 119/ for test: kms_psr
results: parsing output: 120/ for test: sw_sync
results: parsing output: 121/ for test: kms_cursor_legacy
results: parsing output: 122/ for test: syncobj_wait
results: parsing output: 123/ for test: kms_ccs
results: parsing output: 124/ for test: kms_flip_scaled_crc
results: parsing output: 125/ for test: gem_exec_schedule
results: parsing output: 126/ for test: prime_mmap_coherency
results: parsing output: 127/ for test: kms_pm_rpm
results: parsing output: 128/ for test: kms_chamelium_frames
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: gem_mmap_gtt
results: parsing output: 132/ for test: kms_plane_scaling
Done.