[57.866650] Initializing watchdogs [57.866696] /dev/watchdog0 [57.879875] [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] [57.884273] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [57.886703] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [57.890566] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite) [58.014098] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite [64.857810] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.813s) [64.991969] [002/133] (953s left) gem_exec_reloc (basic-gtt-read-noreloc) [65.057159] Subtest basic-gtt-read-noreloc: SKIP (0.000s) [65.130620] [003/133] (953s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible) [65.226830] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible [65.238044] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.010s) [65.331212] [004/133] (953s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0) [65.438897] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0 [66.419631] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (0.979s) [66.554605] [005/133] (951s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc) [66.657740] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc [66.659887] Starting dynamic subtest: pipe-A-eDP-1 [66.717068] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [66.723519] Starting dynamic subtest: pipe-B-eDP-1 [66.768582] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [66.775379] Starting dynamic subtest: pipe-C-eDP-1 [66.825534] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [66.832519] Starting dynamic subtest: pipe-D-eDP-1 [66.876530] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [66.879949] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.007s) [68.814947] [006/133] (949s left) sysfs_preempt_timeout (idempotent) [68.884262] Starting subtest: idempotent [68.886644] Starting dynamic subtest: vecs0 [68.889085] Dynamic subtest vecs0: SUCCESS (0.000s) [68.897067] Starting dynamic subtest: ccs0 [68.899340] Dynamic subtest ccs0: SUCCESS (0.000s) [68.905950] Starting dynamic subtest: vcs0 [68.908240] Dynamic subtest vcs0: SUCCESS (0.000s) [68.914880] Starting dynamic subtest: bcs0 [68.917145] Dynamic subtest bcs0: SUCCESS (0.000s) [68.923581] Starting dynamic subtest: rcs0 [68.925944] Dynamic subtest rcs0: SUCCESS (0.000s) [68.932514] Starting dynamic subtest: vcs1 [68.934497] Dynamic subtest vcs1: SUCCESS (0.000s) [68.936434] Subtest idempotent: SUCCESS (0.004s) [68.981144] [007/133] (949s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu) [69.083577] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu [69.088083] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [69.173263] [008/133] (949s left) kms_rotation_crc (primary-y-tiled-reflect-x-90) [69.257721] Starting subtest: primary-y-tiled-reflect-x-90 [69.262168] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s) [69.324537] [009/133] (949s left) kms_busy (basic-hang) [69.422039] Starting subtest: basic-hang [69.424345] Starting dynamic subtest: flip-pipe-A [70.001659] Dynamic subtest flip-pipe-A: SUCCESS (0.576s) [70.010927] Starting dynamic subtest: modeset-pipe-A [73.437961] Dynamic subtest modeset-pipe-A: SUCCESS (3.433s) [73.447091] Starting dynamic subtest: flip-pipe-D [74.635996] Dynamic subtest flip-pipe-D: SUCCESS (1.192s) [74.643239] Starting dynamic subtest: modeset-pipe-D [78.083916] Dynamic subtest modeset-pipe-D: SUCCESS (3.446s) [78.086479] Subtest basic-hang: SUCCESS (8.651s) [78.871278] [010/133] (939s left) kms_hdr (invalid-hdr) [78.974215] Starting subtest: invalid-hdr [81.079755] Starting dynamic subtest: pipe-A-eDP-1 [83.947301] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.868s) [83.949586] Subtest invalid-hdr: SUCCESS (4.974s) [84.051389] [011/133] (934s left) gem_ctx_param (set-priority-invalid-size) [84.107040] Starting subtest: set-priority-invalid-size [84.109446] Subtest set-priority-invalid-size: SUCCESS (0.000s) [84.181407] [012/133] (934s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt) [84.284513] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt [84.288635] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [84.382591] [013/133] (934s left) api_intel_allocator (open-vm) [84.442802] Starting subtest: open-vm [84.447074] Subtest open-vm: SUCCESS (0.003s) [84.568723] [014/133] (934s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear) [84.660103] Starting subtest: fbcpsr-tiling-linear [91.230136] Subtest fbcpsr-tiling-linear: SUCCESS (6.573s) [91.362487] [015/133] (927s left) gem_softpin (evict-snoop-interruptible) [91.418597] Starting subtest: evict-snoop-interruptible [91.422888] Subtest evict-snoop-interruptible: SKIP (0.000s) [91.529096] [016/133] (927s left) gem_ctx_shared (create-shared-gtt) [91.595254] Starting subtest: create-shared-gtt [93.800999] Subtest create-shared-gtt: SUCCESS (2.152s) [94.093748] [017/133] (924s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling) [94.192659] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-upscaling [94.197189] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SKIP (0.000s) [94.265636] [018/133] (924s left) kms_cursor_crc (cursor-offscreen-512x512) [94.522708] Starting subtest: cursor-offscreen-512x512 [94.527148] Subtest cursor-offscreen-512x512: SKIP (0.001s) [94.699728] [019/133] (924s left) i915_pm_rps (thresholds-idle-park) [94.751084] Starting subtest: thresholds-idle-park [94.755661] Subtest thresholds-idle-park: SKIP (0.000s) [94.866887] [020/133] (924s left) syncobj_timeline (invalid-signal-one-illegal-handle) [94.923762] Starting subtest: invalid-signal-one-illegal-handle [94.925886] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s) [95.022405] [021/133] (924s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-render) [95.114119] Starting subtest: psr-1p-primscrn-pri-indfb-draw-render [102.438233] Subtest psr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.326s) [102.552690] [022/133] (916s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted) [102.603770] Starting subtest: etime-multi-wait-all-for-submit-submitted [102.708101] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.103s) [102.781414] [023/133] (916s left) prime_vgem (basic-read) [102.907854] Starting subtest: basic-read [102.915470] Subtest basic-read: SKIP (0.005s) [103.019356] [FACT prime_vgem (basic-read)] new: kernel.kmod_is_loaded.vgem: true [103.023087] [024/133] (916s left) gem_reg_read (timestamp-moving) [103.083915] Starting subtest: timestamp-moving [104.085033] Subtest timestamp-moving: SUCCESS (1.001s) [104.156649] [025/133] (915s left) gem_ctx_param (basic-default) [104.210850] Starting subtest: basic-default [104.213417] Subtest basic-default: SUCCESS (0.000s) [104.282183] [026/133] (915s left) gem_eio (unwedge-stress) [104.505350] Starting subtest: unwedge-stress [104.508017] Starting dynamic subtest: render [109.270979] Dynamic subtest render: SUCCESS (4.763s) [109.286477] Starting dynamic subtest: bsd1 [127.398108] Dynamic subtest bsd1: SUCCESS (18.125s) [127.412526] Starting dynamic subtest: bsd2 [147.393450] Dynamic subtest bsd2: SUCCESS (19.992s) [147.408247] Starting dynamic subtest: blt [147.412075] Dynamic subtest blt: SKIP (0.000s) [147.420239] Starting dynamic subtest: vebox [167.395080] Dynamic subtest vebox: SUCCESS (19.997s) [167.397076] Subtest unwedge-stress: SUCCESS (62.881s) [168.961277] [027/133] (850s left) gem_exec_reloc (basic-cpu-read-active) [169.025216] Subtest basic-cpu-read-active: SKIP (0.000s) [169.102103] [028/133] (850s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-75) [169.193653] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-75 [169.195888] Starting dynamic subtest: pipe-A [169.217117] Dynamic subtest pipe-A: SKIP (0.022s) [169.226098] Starting dynamic subtest: pipe-B [169.253456] Dynamic subtest pipe-B: SKIP (0.034s) [169.261846] Starting dynamic subtest: pipe-C [169.289558] Dynamic subtest pipe-C: SKIP (0.035s) [169.297815] Starting dynamic subtest: pipe-D [169.319506] Dynamic subtest pipe-D: SKIP (0.031s) [169.323276] Subtest planes-upscale-factor-0-25-downscale-factor-0-75: SKIP (0.125s) [169.430190] [029/133] (850s left) kms_setmode (clone-exclusive-crtc) [169.493058] Starting subtest: clone-exclusive-crtc [169.499520] Subtest clone-exclusive-crtc: SKIP (0.000s) [169.598443] [030/133] (849s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs) [169.694129] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs [169.696058] Starting dynamic subtest: pipe-A-eDP-1 [171.881353] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.188s) [171.890899] Starting dynamic subtest: pipe-B-eDP-1 [174.122196] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.240s) [174.129798] Starting dynamic subtest: pipe-C-eDP-1 [176.143815] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.019s) [176.152219] Starting dynamic subtest: pipe-D-eDP-1 [178.231986] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.086s) [178.233854] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (8.539s) [179.397103] [031/133] (840s left) kms_invalid_mode (zero-hdisplay) [179.493707] Starting subtest: zero-hdisplay [179.496059] Starting dynamic subtest: pipe-A-eDP-1 [179.793321] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.299s) [179.801564] Starting dynamic subtest: pipe-B-eDP-1 [179.803708] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [179.811443] Starting dynamic subtest: pipe-C-eDP-1 [179.813764] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [179.821369] Starting dynamic subtest: pipe-D-eDP-1 [179.823626] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [179.825769] Subtest zero-hdisplay: SUCCESS (0.305s) [180.641698] [032/133] (838s left) gem_exec_params (invalid-bsd1-flag-on-blt) [180.705399] Starting subtest: invalid-bsd1-flag-on-blt [180.707648] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s) [180.805220] [033/133] (838s left) kms_pm_lpsp (kms-lpsp) [181.912317] Starting subtest: kms-lpsp [181.914477] Starting dynamic subtest: pipe-A-eDP-1 [182.057248] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.148s) [182.359160] Subtest kms-lpsp: SUCCESS (0.449s) [183.163994] [034/133] (836s left) i915_pm_rc6_residency (rc6-fence) [183.241957] Starting subtest: rc6-fence [183.269678] Starting dynamic subtest: gt0 [195.611656] Dynamic subtest gt0: SUCCESS (12.324s) [195.621618] Starting dynamic subtest: gt1 [209.880065] Dynamic subtest gt1: SUCCESS (14.280s) [209.882930] Subtest rc6-fence: SUCCESS (26.638s) [209.970348] [035/133] (809s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions) [210.089405] Starting subtest: short-flip-after-cursor-atomic-transitions [211.035071] Subtest short-flip-after-cursor-atomic-transitions: SUCCESS (0.946s) [211.888331] [036/133] (807s left) gem_softpin (allocator-nopin-reserve) [211.951596] Starting subtest: allocator-nopin-reserve [212.038855] Subtest allocator-nopin-reserve: SUCCESS (0.087s) [212.160983] [037/133] (807s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc) [212.253930] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc [212.256242] Starting dynamic subtest: pipe-A-eDP-1 [212.278780] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [212.289021] Starting dynamic subtest: pipe-B-eDP-1 [212.310117] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [212.317569] Starting dynamic subtest: pipe-C-eDP-1 [212.338273] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [212.345899] Starting dynamic subtest: pipe-D-eDP-1 [212.366822] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [212.371035] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s) [214.553695] [038/133] (805s left) kms_flip (flip-vs-panning-vs-hang) [214.651996] Starting subtest: flip-vs-panning-vs-hang [214.654261] Starting dynamic subtest: A-eDP1 [265.408138] Dynamic subtest A-eDP1: SUCCESS (50.750s) [265.417374] Starting dynamic subtest: D-eDP1 [315.394659] Dynamic subtest D-eDP1: SUCCESS (49.987s) [315.397301] Subtest flip-vs-panning-vs-hang: SUCCESS (100.742s) [316.530679] [039/133] (703s left) gem_userptr_blits (process-exit) [316.604763] Starting subtest: process-exit [316.613341] Subtest process-exit: SUCCESS (0.008s) [316.729977] [040/133] (703s left) gem_pwrite (basic-random) [316.784120] Subtest basic-random: SKIP (0.000s) [316.848433] [041/133] (703s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf) [316.935703] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf [316.939782] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s) [317.031590] [042/133] (702s left) api_intel_bb (object-reloc-keep-cache) [317.097781] Starting subtest: object-reloc-keep-cache [317.105397] Subtest object-reloc-keep-cache: SKIP (0.005s) [317.214304] [043/133] (702s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu) [317.313999] Starting subtest: fbc-rgb565-draw-mmap-cpu [321.302183] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (3.991s) [322.459954] [044/133] (697s left) kms_psr (psr2-suspend) [322.557383] Starting subtest: psr2-suspend [322.559758] Starting dynamic subtest: eDP-1 [339.891031] Dynamic subtest eDP-1: SUCCESS (3.770s) [339.893323] Subtest psr2-suspend: SUCCESS (3.771s) [340.804243] [045/133] (679s left) kms_big_fb (x-tiled-64bpp-rotate-180) [340.924601] Starting subtest: x-tiled-64bpp-rotate-180 [342.440724] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.467s) [342.627777] [046/133] (677s left) gem_exec_fence (basic-wait) [342.805838] Starting subtest: basic-wait [342.808559] Starting dynamic subtest: rcs0 [342.892929] Dynamic subtest rcs0: SUCCESS (0.084s) [342.905101] Starting dynamic subtest: bcs0 [342.953492] Dynamic subtest bcs0: SUCCESS (0.057s) [342.965801] Starting dynamic subtest: vcs0 [343.020216] Dynamic subtest vcs0: SUCCESS (0.063s) [343.031862] Starting dynamic subtest: vcs1 [343.075915] Dynamic subtest vcs1: SUCCESS (0.052s) [343.089740] Starting dynamic subtest: vecs0 [343.132621] Dynamic subtest vecs0: SUCCESS (0.051s) [343.143817] Starting dynamic subtest: ccs0 [343.191679] Dynamic subtest ccs0: SUCCESS (0.055s) [343.194337] Subtest basic-wait: SUCCESS (0.377s) [344.546767] [047/133] (675s left) kms_plane_alpha_blend (alpha-basic) [344.639748] Starting subtest: alpha-basic [344.933687] Starting dynamic subtest: pipe-A-eDP-1 [346.912851] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.941s) [346.942773] Starting dynamic subtest: pipe-D-eDP-1 [349.662979] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.691s) [349.665454] Subtest alpha-basic: SUCCESS (4.942s) [350.474461] [048/133] (669s left) perf_pmu (busy-double-start) [350.519110] Starting subtest: busy-double-start [350.521097] Starting dynamic subtest: rcs0 [354.169951] Dynamic subtest rcs0: FAIL (3.567s) [354.180698] Starting dynamic subtest: bcs0 [357.691407] Dynamic subtest bcs0: SUCCESS (3.555s) [357.701877] Starting dynamic subtest: vcs0 [362.002254] Dynamic subtest vcs0: SUCCESS (4.294s) [362.013379] Starting dynamic subtest: vcs1 [365.968567] Dynamic subtest vcs1: SUCCESS (3.956s) [365.980527] Starting dynamic subtest: vecs0 [370.022039] Dynamic subtest vecs0: SUCCESS (4.046s) [370.037135] Starting dynamic subtest: ccs0 [373.661234] Dynamic subtest ccs0: FAIL (3.567s) [373.663231] Subtest busy-double-start: FAIL (22.995s) [373.719002] [049/133] (646s left) gem_exec_store (dword) [373.790127] Starting subtest: dword [373.792097] Starting dynamic subtest: rcs0 [373.870909] Dynamic subtest rcs0: SUCCESS (0.082s) [373.885394] Starting dynamic subtest: bcs0 [373.916745] Dynamic subtest bcs0: SUCCESS (0.043s) [373.926061] Starting dynamic subtest: vcs0 [373.963385] Dynamic subtest vcs0: SUCCESS (0.044s) [373.974104] Starting dynamic subtest: vcs1 [374.008655] Dynamic subtest vcs1: SUCCESS (0.043s) [374.018652] Starting dynamic subtest: vecs0 [374.050979] Dynamic subtest vecs0: SUCCESS (0.040s) [374.061127] Starting dynamic subtest: ccs0 [374.095850] Dynamic subtest ccs0: SUCCESS (0.043s) [374.098437] Subtest dword: SUCCESS (0.308s) [374.283726] [050/133] (646s left) kms_psr (fbc-pr-cursor-plane-onoff) [374.386835] Starting subtest: fbc-pr-cursor-plane-onoff [374.390957] Subtest fbc-pr-cursor-plane-onoff: SKIP (0.000s) [374.460393] [051/133] (645s left) gem_userptr_blits (nohangcheck) [374.528126] Starting subtest: nohangcheck [374.773556] Subtest nohangcheck: SUCCESS (0.245s) [374.878024] [052/133] (645s left) kms_psr (fbc-psr-sprite-plane-onoff) [374.965760] Starting subtest: fbc-psr-sprite-plane-onoff [374.968019] Starting dynamic subtest: eDP-1 [374.972317] Dynamic subtest eDP-1: SKIP (0.000s) [374.976654] Subtest fbc-psr-sprite-plane-onoff: SKIP (0.001s) [375.039014] [053/133] (645s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted) [375.102641] Starting subtest: invalid-multi-wait-all-unsubmitted [375.104928] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s) [375.210360] [054/133] (645s left) kms_addfb_basic (bad-pitch-65536) [375.268645] Starting subtest: bad-pitch-65536 [375.270903] Subtest bad-pitch-65536: SUCCESS (0.000s) [375.408207] [055/133] (645s left) gem_gpgpu_fill (basic) [375.470736] Starting subtest: basic [375.473127] Starting dynamic subtest: smem [375.478076] Dynamic subtest smem: SUCCESS (0.009s) [375.480610] Subtest basic: SUCCESS (0.010s) [375.598996] [056/133] (645s left) prime_vgem (shrink) [375.679684] Starting subtest: shrink [375.693923] Subtest shrink: SUCCESS (0.012s) [375.793374] [057/133] (644s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip) [375.879280] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip [376.826644] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (0.945s) [376.946048] [058/133] (643s left) kms_content_protection (mei-interface) [377.084426] Starting subtest: mei-interface [377.088980] Subtest mei-interface: SKIP (0.001s) [377.226934] [059/133] (643s left) gem_ctx_shared (q-out-order) [377.289205] Starting subtest: Q-out-order [377.291138] Starting dynamic subtest: rcs0 [377.385595] Dynamic subtest rcs0: SUCCESS (0.095s) [377.402249] Starting dynamic subtest: vcs0 [377.468220] Dynamic subtest vcs0: SUCCESS (0.080s) [377.484888] Starting dynamic subtest: vcs1 [377.550466] Dynamic subtest vcs1: SUCCESS (0.082s) [377.568696] Starting dynamic subtest: vecs0 [377.620768] Dynamic subtest vecs0: SUCCESS (0.069s) [377.637424] Starting dynamic subtest: ccs0 [377.694222] Dynamic subtest ccs0: SUCCESS (0.073s) [377.697073] Subtest Q-out-order: SUCCESS (0.405s) [378.530335] [060/133] (642s left) gem_mmap_gtt (ptrace) [378.588755] Subtest ptrace: SKIP (0.000s) [378.649825] [061/133] (642s left) i915_hangman (gt-error-state-capture) [378.713703] Starting subtest: gt-error-state-capture [378.716125] Starting dynamic subtest: rcs0 [390.450036] Dynamic subtest rcs0: SUCCESS (11.731s) [390.462980] Starting dynamic subtest: bcs0 [402.417201] Dynamic subtest bcs0: SUCCESS (11.959s) [402.429608] Starting dynamic subtest: vcs0 [414.384362] Dynamic subtest vcs0: SUCCESS (11.959s) [414.397618] Starting dynamic subtest: vcs1 [425.392052] Dynamic subtest vcs1: SUCCESS (11.001s) [425.404316] Starting dynamic subtest: vecs0 [437.425109] Dynamic subtest vecs0: SUCCESS (12.026s) [437.438464] Starting dynamic subtest: ccs0 [449.456188] Dynamic subtest ccs0: SUCCESS (12.032s) [449.458824] Subtest gt-error-state-capture: SUCCESS (70.724s) [449.554676] [062/133] (571s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-render) [449.671240] Starting subtest: psr-2p-primscrn-spr-indfb-draw-render [449.675663] Subtest psr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [449.777034] [063/133] (571s left) gen9_exec_parse (cmd-crossing-page) [449.827871] Subtest cmd-crossing-page: SKIP (0.000s) [449.903406] [064/133] (571s left) kms_big_fb (yf-tiled-8bpp-rotate-180) [450.005738] Starting subtest: yf-tiled-8bpp-rotate-180 [450.010237] Subtest yf-tiled-8bpp-rotate-180: SKIP (0.000s) [450.109785] [065/133] (570s left) gem_ringfill (legacy-basic) [455.445381] Starting subtest: legacy-basic [455.447973] Starting dynamic subtest: default [455.492637] Dynamic subtest default: SUCCESS (0.047s) [455.504918] Starting dynamic subtest: render [455.535931] Dynamic subtest render: SUCCESS (0.041s) [455.546392] Starting dynamic subtest: bsd [455.579090] Dynamic subtest bsd: SUCCESS (0.041s) [455.589771] Starting dynamic subtest: bsd1 [455.619648] Dynamic subtest bsd1: SUCCESS (0.038s) [455.633193] Starting dynamic subtest: bsd2 [455.663905] Dynamic subtest bsd2: SUCCESS (0.041s) [455.675090] Starting dynamic subtest: blt [455.708950] Dynamic subtest blt: SUCCESS (0.042s) [455.718524] Starting dynamic subtest: vebox [455.753788] Dynamic subtest vebox: SUCCESS (0.042s) [455.756177] Subtest legacy-basic: SUCCESS (0.311s) [455.837064] [066/133] (565s left) kms_cursor_crc (cursor-random-64x21) [456.028364] Starting subtest: cursor-random-64x21 [456.078168] Subtest cursor-random-64x21: SKIP (0.044s) [456.342552] [067/133] (564s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers) [456.449547] Starting subtest: plane-downscale-factor-0-5-with-modifiers [456.451893] Starting dynamic subtest: pipe-A [456.467939] Dynamic subtest pipe-A: SKIP (0.016s) [456.477183] Starting dynamic subtest: pipe-B [456.497395] Dynamic subtest pipe-B: SKIP (0.030s) [456.506600] Starting dynamic subtest: pipe-C [456.529120] Dynamic subtest pipe-C: SKIP (0.030s) [456.538044] Starting dynamic subtest: pipe-D [456.558787] Dynamic subtest pipe-D: SKIP (0.029s) [456.562304] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.108s) [456.665744] [068/133] (564s left) kms_flip (flip-vs-suspend) [456.752046] Starting subtest: flip-vs-suspend [456.754239] Starting dynamic subtest: A-eDP1 [505.502350] Dynamic subtest A-eDP1: SUCCESS (4.681s) [505.519418] Starting dynamic subtest: B-eDP1 [554.488286] Dynamic subtest B-eDP1: SUCCESS (4.428s) [554.502225] Starting dynamic subtest: C-eDP1 [603.506613] Dynamic subtest C-eDP1: SUCCESS (4.460s) [603.518461] Starting dynamic subtest: D-eDP1 [652.510350] Dynamic subtest D-eDP1: SUCCESS (4.454s) [652.516449] Subtest flip-vs-suspend: SUCCESS (18.034s) [653.728001] [069/133] (367s left) kms_psr (fbc-pr-primary-page-flip) [653.830573] Starting subtest: fbc-pr-primary-page-flip [653.835556] Subtest fbc-pr-primary-page-flip: SKIP (0.000s) [653.902986] [070/133] (367s left) kms_universal_plane (disable-primary-vs-flip) [653.995924] Starting subtest: disable-primary-vs-flip [653.998893] Starting dynamic subtest: pipe-A-eDP-1 [655.578475] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.535s) [655.588949] Starting dynamic subtest: pipe-B-eDP-1 [658.040541] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.403s) [658.052579] Starting dynamic subtest: pipe-C-eDP-1 [660.391075] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.307s) [660.401882] Starting dynamic subtest: pipe-D-eDP-1 [662.594251] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.172s) [662.597143] Subtest disable-primary-vs-flip: SUCCESS (8.424s) [663.399705] [071/133] (357s left) kms_rotation_crc (primary-rotation-270) [663.497209] Starting subtest: primary-rotation-270 [663.502144] Subtest primary-rotation-270: SKIP (0.001s) [663.571246] [072/133] (357s left) kms_vblank (wait-forked-hang) [663.662429] Starting subtest: wait-forked-hang [663.664793] Starting dynamic subtest: pipe-A-eDP-1 [690.558212] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.820s) [690.572377] Starting dynamic subtest: pipe-D-eDP-1 [705.526148] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.958s) [705.529087] Subtest wait-forked-hang: SUCCESS (41.782s) [706.376128] [073/133] (314s left) i915_query (query-topology-kernel-writes) [706.439411] Starting subtest: query-topology-kernel-writes [706.441942] Subtest query-topology-kernel-writes: SUCCESS (0.000s) [706.525223] [074/133] (314s left) kms_pm_rpm (legacy-planes) [708.049029] Starting subtest: legacy-planes [708.051467] Starting dynamic subtest: plane-64 [716.330309] Dynamic subtest plane-64: SUCCESS (8.281s) [716.346186] Starting dynamic subtest: plane-94 [724.615556] Dynamic subtest plane-94: SUCCESS (8.279s) [724.631159] Starting dynamic subtest: plane-124 [732.890263] Dynamic subtest plane-124: SUCCESS (8.268s) [732.901816] Starting dynamic subtest: plane-134 [741.159936] Dynamic subtest plane-134: SUCCESS (8.263s) [741.163092] Subtest legacy-planes: SUCCESS (33.102s) [741.536921] [075/133] (279s left) gem_ctx_persistence (engines-queued) [741.591082] Starting subtest: engines-queued [741.593771] Starting dynamic subtest: rcs0 [741.657387] Dynamic subtest rcs0: SUCCESS (0.066s) [741.668811] Starting dynamic subtest: bcs0 [741.682111] Dynamic subtest bcs0: SUCCESS (0.023s) [741.691811] Starting dynamic subtest: vcs0 [743.765239] Dynamic subtest vcs0: SUCCESS (2.080s) [743.776513] Starting dynamic subtest: vcs1 [745.749224] Dynamic subtest vcs1: SUCCESS (1.980s) [745.762047] Starting dynamic subtest: vecs0 [747.790606] Dynamic subtest vecs0: SUCCESS (1.979s) [747.803171] Starting dynamic subtest: ccs0 [747.918501] Dynamic subtest ccs0: SUCCESS (0.184s) [747.921997] Subtest engines-queued: SUCCESS (6.325s) [748.031660] [076/133] (273s left) gem_exec_schedule (u-semaphore-user) [748.102666] Starting subtest: u-semaphore-user [748.164091] Subtest u-semaphore-user: SUCCESS (0.063s) [749.804028] [077/133] (271s left) gem_exec_create (basic) [749.868506] Starting subtest: basic [749.871413] Starting dynamic subtest: smem [752.822427] Dynamic subtest smem: SUCCESS (2.954s) [752.825540] Subtest basic: SUCCESS (2.956s) [753.010451] [078/133] (268s left) gem_blits (basic) [753.070550] Starting subtest: basic [755.315516] Subtest basic: SUCCESS (2.191s) [755.381891] [079/133] (266s left) gem_exec_reloc (basic-gtt) [755.446044] Subtest basic-gtt: SKIP (0.000s) [755.512503] [080/133] (266s left) gem_pxp (reject-modify-context-protection-off-3) [755.642395] Starting subtest: reject-modify-context-protection-off-3 [755.645318] Subtest reject-modify-context-protection-off-3: SUCCESS (0.002s) [755.762959] [081/133] (265s left) kms_async_flips (test-time-stamp-atomic) [755.855231] Starting subtest: test-time-stamp-atomic [756.239339] Starting dynamic subtest: pipe-A-eDP-1 [757.032614] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.792s) [757.402241] Starting dynamic subtest: pipe-B-eDP-1 [758.170563] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.772s) [758.541502] Starting dynamic subtest: pipe-C-eDP-1 [759.296496] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.759s) [759.664130] Starting dynamic subtest: pipe-D-eDP-1 [760.426237] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.770s) [760.428896] Subtest test-time-stamp-atomic: SUCCESS (4.573s) [761.582990] [082/133] (260s left) gem_exec_suspend (basic-s3-devices) [761.660938] Starting subtest: basic-S3-devices [761.663544] Starting dynamic subtest: smem [772.726985] Dynamic subtest smem: SUCCESS (11.065s) [772.730124] Subtest basic-S3-devices: SUCCESS (11.068s) [772.917985] [083/133] (248s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe) [773.310996] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s) [774.112734] [084/133] (247s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render) [774.214512] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render [774.219780] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [774.307307] [085/133] (247s left) gem_exec_schedule (preempt-queue-chain) [774.377989] Subtest preempt-queue-chain: SKIP (0.000s) [774.671037] [086/133] (247s left) gem_exec_reloc (basic-write-gtt-active) [774.719960] Subtest basic-write-gtt-active: SKIP (0.000s) [774.789530] [087/133] (247s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff) [774.881391] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff [774.886543] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s) [774.963015] [088/133] (247s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs-cc) [775.056209] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs-cc [775.058768] Starting dynamic subtest: pipe-A-eDP-1 [775.091195] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [775.113153] Starting dynamic subtest: pipe-B-eDP-1 [775.145384] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [775.166545] Starting dynamic subtest: pipe-C-eDP-1 [775.198316] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [775.216375] Starting dynamic subtest: pipe-D-eDP-1 [775.244781] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [775.249775] Subtest random-ccs-data-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s) [777.291469] [089/133] (244s left) kms_psr (psr-primary-mmap-gtt) [777.402792] Starting subtest: psr-primary-mmap-gtt [777.405441] Starting dynamic subtest: eDP-1 [778.800858] Dynamic subtest eDP-1: SKIP (1.395s) [778.806796] Subtest psr-primary-mmap-gtt: SKIP (1.397s) [778.938260] [090/133] (243s left) kms_psr (pr-primary-render) [779.042547] Starting subtest: pr-primary-render [779.047968] Subtest pr-primary-render: SKIP (0.000s) [779.113631] [091/133] (243s left) kms_prop_blob (blob-prop-validate) [779.171226] Starting subtest: blob-prop-validate [779.173510] Subtest blob-prop-validate: SUCCESS (0.000s) [779.252827] [092/133] (242s left) gem_exec_reloc (basic-gtt-wc-active) [779.323309] Subtest basic-gtt-wc-active: SKIP (0.000s) [779.398008] [093/133] (242s left) gem_mmap_gtt (cpuset-medium-copy) [779.450382] Subtest cpuset-medium-copy: SKIP (0.000s) [779.514561] [094/133] (242s left) perf_pmu (busy-no-semaphores) [779.554696] Starting subtest: busy-no-semaphores [779.557417] Starting dynamic subtest: rcs0 [780.098857] Dynamic subtest rcs0: SUCCESS (0.545s) [780.112251] Starting dynamic subtest: bcs0 [780.650508] Dynamic subtest bcs0: SUCCESS (0.548s) [780.664394] Starting dynamic subtest: vcs0 [781.201549] Dynamic subtest vcs0: SUCCESS (0.548s) [781.214507] Starting dynamic subtest: vcs1 [782.330033] Dynamic subtest vcs1: SUCCESS (1.125s) [782.343688] Starting dynamic subtest: vecs0 [784.313307] Dynamic subtest vecs0: SUCCESS (1.979s) [784.326427] Starting dynamic subtest: ccs0 [786.300864] Dynamic subtest ccs0: SUCCESS (1.984s) [786.303866] Subtest busy-no-semaphores: SUCCESS (6.749s) [786.432719] [095/133] (235s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc) [786.531590] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc [786.534062] Starting dynamic subtest: pipe-A-eDP-1 [786.557264] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [786.571320] Starting dynamic subtest: pipe-B-eDP-1 [786.596435] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [786.606052] Starting dynamic subtest: pipe-C-eDP-1 [786.631313] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [786.640467] Starting dynamic subtest: pipe-D-eDP-1 [786.667417] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [786.672211] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.006s) [788.788447] [096/133] (233s left) kms_cursor_crc (cursor-sliding-32x10) [788.962466] Starting subtest: cursor-sliding-32x10 [789.008454] Subtest cursor-sliding-32x10: SKIP (0.041s) [789.272069] [097/133] (233s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions) [789.394868] Starting subtest: cursor-vs-flip-atomic-transitions [819.315088] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (29.915s) [820.114889] [098/133] (202s left) gem_create (create-massive) [820.168222] Starting subtest: create-massive [820.170966] Subtest create-massive: SUCCESS (0.000s) [820.355084] [099/133] (202s left) syncobj_wait (multi-wait-for-submit-submitted) [820.413344] Starting subtest: multi-wait-for-submit-submitted [820.513851] Subtest multi-wait-for-submit-submitted: SUCCESS (0.102s) [820.600770] [100/133] (201s left) kms_big_fb (y-tiled-8bpp-rotate-180) [820.700254] Starting subtest: y-tiled-8bpp-rotate-180 [820.705381] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s) [820.799386] [101/133] (201s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy) [820.928125] Starting subtest: 2x-long-flip-vs-cursor-legacy [820.932729] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s) [821.082294] [102/133] (201s left) vgem_basic (create) [821.129086] Starting subtest: create [821.131372] Subtest create: SUCCESS (0.000s) [821.188142] [103/133] (201s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled) [821.238646] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [821.241318] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [821.327108] [104/133] (201s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [821.435716] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [822.072365] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.637s) [822.234423] [105/133] (200s left) gem_partial_pwrite_pread (reads-display) [822.301341] Subtest reads-display: SKIP (0.000s) [822.377302] [106/133] (200s left) syncobj_timeline (wait-all-snapshot) [822.426189] Starting subtest: wait-all-snapshot [822.506288] Subtest wait-all-snapshot: SUCCESS (0.082s) [822.582390] [107/133] (200s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt) [822.687150] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt [822.691439] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [822.781047] [108/133] (200s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [822.889771] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-gtt [822.894723] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [823.016648] [109/133] (199s left) gem_exec_reloc (basic-write-gtt) [823.071784] Subtest basic-write-gtt: SKIP (0.000s) [823.140463] [110/133] (199s left) kms_chamelium_edid (dp-edid-read) [823.524696] Subtest dp-edid-read: SKIP (0.000s) [824.334496] [111/133] (198s left) kms_async_flips (crc) [824.428573] Starting subtest: crc [824.796505] Starting dynamic subtest: pipe-A-eDP-1 [827.691659] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.875s) [828.051536] Starting dynamic subtest: pipe-B-eDP-1 [831.023967] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.951s) [831.390122] Starting dynamic subtest: pipe-C-eDP-1 [834.264142] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.845s) [834.586065] Starting dynamic subtest: pipe-D-eDP-1 [837.485825] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.877s) [837.488534] Subtest crc: SUCCESS (13.025s) [838.618079] [112/133] (184s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-pwrite) [838.740658] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-pwrite [838.746122] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [838.831930] [113/133] (184s left) core_getversion (basic) [838.877522] Starting subtest: basic [838.883301] Subtest basic: SUCCESS (0.000s) [838.944209] [114/133] (184s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier) [839.043339] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier [839.048094] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier: SKIP (0.000s) [839.117837] [115/133] (184s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt) [839.215274] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt [846.609318] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.397s) [846.736538] [116/133] (176s left) kms_fbcon_fbt (psr-suspend) [846.796570] Starting subtest: psr-suspend [896.542530] Subtest psr-suspend: SUCCESS (19.604s) [896.584525] [117/133] (126s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-render) [896.684438] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-render [900.818323] Subtest fbc-1p-offscreen-pri-indfb-draw-render: SUCCESS (4.140s) [902.033346] [118/133] (121s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier) [902.121537] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier [902.125935] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s) [902.192935] [119/133] (121s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted) [902.243352] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted [902.348008] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.104s) [902.424998] [120/133] (120s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted) [902.470172] Starting subtest: multi-wait-all-for-submit-unsubmitted [902.572177] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.102s) [902.651226] [121/133] (120s left) kms_legacy_colorkey (basic) [902.746971] Starting subtest: basic [902.749286] Starting dynamic subtest: pipe-A [902.790802] Dynamic subtest pipe-A: SUCCESS (0.045s) [902.803809] Starting dynamic subtest: pipe-B [902.806400] Dynamic subtest pipe-B: SUCCESS (0.000s) [902.816155] Starting dynamic subtest: pipe-C [902.818545] Dynamic subtest pipe-C: SUCCESS (0.000s) [902.827965] Starting dynamic subtest: pipe-D [902.830143] Dynamic subtest pipe-D: SUCCESS (0.000s) [902.832491] Subtest basic: SUCCESS (0.051s) [902.871568] [122/133] (120s left) gen9_exec_parse (unaligned-access) [902.927263] Subtest unaligned-access: SKIP (0.000s) [903.003664] [123/133] (120s left) gem_fence_thrash (bo-write-verify-none) [903.041005] Starting subtest: bo-write-verify-none [903.056756] Subtest bo-write-verify-none: SKIP (0.012s) [903.126282] [124/133] (120s left) gem_exec_gttfill (all-engines) [903.188561] Starting subtest: all-engines [926.144506] Subtest all-engines: SUCCESS (22.954s) [926.359529] [125/133] ( 97s left) gem_partial_pwrite_pread (write-snoop) [926.465464] Subtest write-snoop: SKIP (0.000s) [926.532290] [126/133] ( 97s left) gem_exec_balancer (parallel-bb-first) [926.791058] Starting subtest: parallel-bb-first [927.744935] Subtest parallel-bb-first: SUCCESS (0.954s) [928.887476] [127/133] ( 94s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-cpu) [928.991119] Starting subtest: fbc-rgb101010-draw-mmap-cpu [933.592303] Subtest fbc-rgb101010-draw-mmap-cpu: SUCCESS (4.603s) [934.724248] [128/133] ( 89s left) kms_cursor_legacy (forked-move) [934.861424] Starting subtest: forked-move [934.863586] Starting dynamic subtest: pipe-A [940.317052] Dynamic subtest pipe-A: SUCCESS (5.453s) [940.330392] Starting dynamic subtest: pipe-B [945.835816] Dynamic subtest pipe-B: SUCCESS (5.463s) [945.847663] Starting dynamic subtest: pipe-C [951.313011] Dynamic subtest pipe-C: SUCCESS (5.476s) [951.325751] Starting dynamic subtest: pipe-D [956.794774] Dynamic subtest pipe-D: SUCCESS (5.480s) [956.816277] Starting dynamic subtest: all-pipes [962.282116] Dynamic subtest all-pipes: SUCCESS (5.484s) [962.285132] Subtest forked-move: SUCCESS (27.366s) [962.418404] [129/133] ( 61s left) kms_color (deep-color) [962.516815] Starting subtest: deep-color [962.532927] Starting dynamic subtest: pipe-A-eDP-1-gamma [963.250953] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.719s) [963.262402] Starting dynamic subtest: pipe-A-eDP-1-degamma [964.662385] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.409s) [964.673657] Starting dynamic subtest: pipe-A-eDP-1-ctm [966.088067] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.427s) [966.848554] Starting dynamic subtest: pipe-B-eDP-1-gamma [967.591191] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.748s) [967.601546] Starting dynamic subtest: pipe-B-eDP-1-degamma [969.062624] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.473s) [969.073020] Starting dynamic subtest: pipe-B-eDP-1-ctm [970.484733] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.420s) [971.255165] Starting dynamic subtest: pipe-C-eDP-1-gamma [971.932454] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.692s) [971.943630] Starting dynamic subtest: pipe-C-eDP-1-degamma [973.307807] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.374s) [973.318744] Starting dynamic subtest: pipe-C-eDP-1-ctm [974.734129] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.426s) [975.545745] Starting dynamic subtest: pipe-D-eDP-1-gamma [976.243059] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.703s) [976.253809] Starting dynamic subtest: pipe-D-eDP-1-degamma [977.696669] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.454s) [977.713905] Starting dynamic subtest: pipe-D-eDP-1-ctm [979.130841] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.432s) [979.133070] Subtest deep-color: SUCCESS (16.612s) [979.974271] [130/133] ( 43s left) gem_bad_reloc (negative-reloc-bltcopy) [980.049661] Subtest negative-reloc-bltcopy: SKIP (0.000s) [980.118037] [131/133] ( 43s left) kms_dsc (dsc-basic) [980.219688] Starting subtest: dsc-basic [980.234771] Subtest dsc-basic: SKIP (0.000s) [980.293891] [132/133] ( 43s left) gem_exec_fence (syncobj-timeline-chain-engines) [980.868618] Starting subtest: syncobj-timeline-chain-engines [980.979118] Subtest syncobj-timeline-chain-engines: SUCCESS (0.111s) [981.988865] [133/133] ( 42s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc) [982.094127] Starting subtest: psr-rgb565-draw-mmap-wc [988.875371] Subtest psr-rgb565-draw-mmap-wc: SUCCESS (6.784s) [988.989450] Closing watchdogs results: parsing output: 0/ for test: kms_frontbuffer_tracking results: parsing output: 1/ for test: gem_exec_reloc results: parsing output: 2/ for test: kms_flip results: parsing output: 3/ for test: kms_big_fb results: parsing output: 4/ for test: kms_ccs results: parsing output: 5/ for test: sysfs_preempt_timeout results: parsing output: 6/ for test: kms_frontbuffer_tracking results: parsing output: 7/ for test: kms_rotation_crc results: parsing output: 8/ for test: kms_busy results: parsing output: 9/ for test: kms_hdr results: parsing output: 10/ for test: gem_ctx_param results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: api_intel_allocator results: parsing output: 13/ for test: kms_frontbuffer_tracking results: parsing output: 14/ for test: gem_softpin results: parsing output: 15/ for test: gem_ctx_shared results: parsing output: 16/ for test: kms_flip_scaled_crc results: parsing output: 17/ for test: kms_cursor_crc results: parsing output: 18/ for test: i915_pm_rps results: parsing output: 19/ for test: syncobj_timeline results: parsing output: 20/ for test: kms_frontbuffer_tracking results: parsing output: 21/ for test: syncobj_timeline results: parsing output: 22/ for test: prime_vgem results: parsing output: 23/ for test: gem_reg_read results: parsing output: 24/ for test: gem_ctx_param results: parsing output: 25/ for test: gem_eio results: parsing output: 26/ for test: gem_exec_reloc results: parsing output: 27/ for test: kms_plane_scaling results: parsing output: 28/ for test: kms_setmode results: parsing output: 29/ for test: kms_ccs results: parsing output: 30/ for test: kms_invalid_mode results: parsing output: 31/ for test: gem_exec_params results: parsing output: 32/ for test: kms_pm_lpsp results: parsing output: 33/ for test: i915_pm_rc6_residency results: parsing output: 34/ for test: kms_cursor_legacy results: parsing output: 35/ for test: gem_softpin results: parsing output: 36/ for test: kms_ccs results: parsing output: 37/ for test: kms_flip results: parsing output: 38/ for test: gem_userptr_blits results: parsing output: 39/ for test: gem_pwrite results: parsing output: 40/ for test: kms_psr2_sf results: parsing output: 41/ for test: api_intel_bb results: parsing output: 42/ for test: kms_frontbuffer_tracking results: parsing output: 43/ for test: kms_psr results: parsing output: 44/ for test: kms_big_fb results: parsing output: 45/ for test: gem_exec_fence results: parsing output: 46/ for test: kms_plane_alpha_blend results: parsing output: 47/ for test: perf_pmu results: parsing output: 48/ for test: gem_exec_store results: parsing output: 49/ for test: kms_psr results: parsing output: 50/ for test: gem_userptr_blits results: parsing output: 51/ for test: kms_psr results: parsing output: 52/ for test: syncobj_timeline results: parsing output: 53/ for test: kms_addfb_basic results: parsing output: 54/ for test: gem_gpgpu_fill results: parsing output: 55/ for test: prime_vgem results: parsing output: 56/ for test: kms_big_fb results: parsing output: 57/ for test: kms_content_protection results: parsing output: 58/ for test: gem_ctx_shared results: parsing output: 59/ for test: gem_mmap_gtt results: parsing output: 60/ for test: i915_hangman results: parsing output: 61/ for test: kms_frontbuffer_tracking results: parsing output: 62/ for test: gen9_exec_parse results: parsing output: 63/ for test: kms_big_fb results: parsing output: 64/ for test: gem_ringfill results: parsing output: 65/ for test: kms_cursor_crc results: parsing output: 66/ for test: kms_plane_scaling results: parsing output: 67/ for test: kms_flip results: parsing output: 68/ for test: kms_psr results: parsing output: 69/ for test: kms_universal_plane results: parsing output: 70/ for test: kms_rotation_crc results: parsing output: 71/ for test: kms_vblank results: parsing output: 72/ for test: i915_query results: parsing output: 73/ for test: kms_pm_rpm results: parsing output: 74/ for test: gem_ctx_persistence results: parsing output: 75/ for test: gem_exec_schedule results: parsing output: 76/ for test: gem_exec_create results: parsing output: 77/ for test: gem_blits results: parsing output: 78/ for test: gem_exec_reloc results: parsing output: 79/ for test: gem_pxp results: parsing output: 80/ for test: kms_async_flips results: parsing output: 81/ for test: gem_exec_suspend results: parsing output: 82/ for test: kms_chamelium_hpd results: parsing output: 83/ for test: kms_frontbuffer_tracking results: parsing output: 84/ for test: gem_exec_schedule results: parsing output: 85/ for test: gem_exec_reloc results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: kms_ccs results: parsing output: 88/ for test: kms_psr results: parsing output: 89/ for test: kms_psr results: parsing output: 90/ for test: kms_prop_blob results: parsing output: 91/ for test: gem_exec_reloc results: parsing output: 92/ for test: gem_mmap_gtt results: parsing output: 93/ for test: perf_pmu results: parsing output: 94/ for test: kms_ccs results: parsing output: 95/ for test: kms_cursor_crc results: parsing output: 96/ for test: kms_cursor_legacy results: parsing output: 97/ for test: gem_create results: parsing output: 98/ for test: syncobj_wait results: parsing output: 99/ for test: kms_big_fb results: parsing output: 100/ for test: kms_cursor_legacy results: parsing output: 101/ for test: vgem_basic results: parsing output: 102/ for test: syncobj_timeline results: parsing output: 103/ for test: kms_big_fb results: parsing output: 104/ for test: gem_partial_pwrite_pread results: parsing output: 105/ for test: syncobj_timeline results: parsing output: 106/ for test: kms_frontbuffer_tracking results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: gem_exec_reloc results: parsing output: 109/ for test: kms_chamelium_edid results: parsing output: 110/ for test: kms_async_flips results: parsing output: 111/ for test: kms_frontbuffer_tracking results: parsing output: 112/ for test: core_getversion results: parsing output: 113/ for test: kms_plane results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: kms_fbcon_fbt results: parsing output: 116/ for test: kms_frontbuffer_tracking results: parsing output: 117/ for test: kms_plane results: parsing output: 118/ for test: syncobj_wait results: parsing output: 119/ for test: syncobj_wait results: parsing output: 120/ for test: kms_legacy_colorkey results: parsing output: 121/ for test: gen9_exec_parse results: parsing output: 122/ for test: gem_fence_thrash results: parsing output: 123/ for test: gem_exec_gttfill results: parsing output: 124/ for test: gem_partial_pwrite_pread results: parsing output: 125/ for test: gem_exec_balancer results: parsing output: 126/ for test: kms_frontbuffer_tracking results: parsing output: 127/ for test: kms_cursor_legacy results: parsing output: 128/ for test: kms_color results: parsing output: 129/ for test: gem_bad_reloc results: parsing output: 130/ for test: kms_dsc results: parsing output: 131/ for test: gem_exec_fence results: parsing output: 132/ for test: kms_frontbuffer_tracking Done.