[39.138504] Initializing watchdogs [39.138606] /dev/watchdog0 [39.145355] [001/130] (960s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted) [39.193950] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted [39.196653] Subtest multi-wait-for-submit-available-unsubmitted-submitted: SUCCESS (0.000s) [39.273079] [002/130] (960s left) kms_chamelium_frames (hdmi-aspect-ratio) [39.649875] Subtest hdmi-aspect-ratio: SKIP (0.000s) [40.500824] [003/130] (959s left) gem_exec_reloc (basic-gtt-wc) [40.556626] Subtest basic-gtt-wc: SKIP (0.000s) [40.584692] [004/130] (959s left) kms_vblank (invalid) [40.683785] Starting subtest: invalid [40.686133] Starting dynamic subtest: pipe-A-eDP-1 [41.071073] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.386s) [41.073564] Subtest invalid: SUCCESS (0.386s) [41.988971] [005/130] (957s left) gem_exec_reloc (basic-cpu-read) [42.042069] Subtest basic-cpu-read: SKIP (0.000s) [42.096842] [006/130] (957s left) kms_pm_dc (dc9-dpms) [42.192599] Starting subtest: dc9-dpms [43.580541] Subtest dc9-dpms: SUCCESS (1.390s) [43.622644] [007/130] (956s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-factor-0-25) [43.713077] Starting subtest: planes-downscale-factor-0-5-upscale-factor-0-25 [43.715534] Starting dynamic subtest: pipe-A [43.725122] Dynamic subtest pipe-A: SKIP (0.004s) [43.732317] Starting dynamic subtest: pipe-B [43.741496] Dynamic subtest pipe-B: SKIP (0.016s) [43.746654] Starting dynamic subtest: pipe-C [43.757083] Dynamic subtest pipe-C: SKIP (0.016s) [43.766100] Starting dynamic subtest: pipe-D [43.775279] Dynamic subtest pipe-D: SKIP (0.016s) [43.779456] Subtest planes-downscale-factor-0-5-upscale-factor-0-25: SKIP (0.052s) [43.833634] [008/130] (955s left) perf (non-sampling-read-error) [43.973756] Starting subtest: non-sampling-read-error [43.983074] Subtest non-sampling-read-error: SUCCESS (0.011s) [44.011121] [009/130] (955s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu) [44.112095] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu [44.116837] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [44.198966] [010/130] (955s left) gem_exec_schedule (submit-golden-slice) [44.263783] Starting subtest: submit-golden-slice [44.265694] Starting dynamic subtest: rcs0 [44.289458] Dynamic subtest rcs0: SUCCESS (0.034s) [44.296272] Starting dynamic subtest: bcs0 [44.312558] Dynamic subtest bcs0: SUCCESS (0.023s) [44.318384] Starting dynamic subtest: vcs0 [44.338678] Dynamic subtest vcs0: SUCCESS (0.026s) [44.349722] Starting dynamic subtest: vcs1 [44.363118] Dynamic subtest vcs1: SUCCESS (0.024s) [44.371090] Starting dynamic subtest: vecs0 [44.382824] Dynamic subtest vecs0: SUCCESS (0.020s) [44.388293] Starting dynamic subtest: ccs0 [44.407947] Dynamic subtest ccs0: SUCCESS (0.025s) [44.410254] Subtest submit-golden-slice: SUCCESS (0.153s) [45.428813] [011/130] (954s left) gem_set_tiling_vs_gtt [45.510299] [012/130] (954s left) intel_hwmon (hwmon-write) [45.552065] Subtest hwmon-write: SKIP (0.000s) [45.577188] [013/130] (954s left) gem_mmap_gtt (medium-copy-xy) [45.625620] Subtest medium-copy-XY: SKIP (0.000s) [45.665677] [014/130] (954s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt) [45.755620] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt [48.936404] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (3.185s) [49.047838] [015/130] (950s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-pwrite) [49.134054] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-pwrite [49.137611] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [49.205224] [016/130] (950s left) kms_rotation_crc (primary-4-tiled-reflect-x-0) [49.289184] Starting subtest: primary-4-tiled-reflect-x-0 [56.328113] Subtest primary-4-tiled-reflect-x-0: SUCCESS (7.039s) [57.541481] [017/130] (942s left) kms_lease (atomic-implicit-crtc) [57.640973] Starting subtest: atomic-implicit-crtc [57.643821] Starting dynamic subtest: pipe-A-eDP-1 [57.659873] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [57.666208] Starting dynamic subtest: pipe-B-eDP-1 [57.677682] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.007s) [57.683092] Starting dynamic subtest: pipe-C-eDP-1 [57.694097] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.006s) [57.699544] Starting dynamic subtest: pipe-D-eDP-1 [57.710848] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.006s) [57.712833] Subtest atomic-implicit-crtc: SUCCESS (0.023s) [57.744858] [018/130] (942s left) gem_create (hog-create) [57.797405] Starting subtest: hog-create [57.799740] Starting dynamic subtest: smem0 [91.375935] Dynamic subtest smem0: SUCCESS (33.578s) [91.378321] Subtest hog-create: SUCCESS (33.578s) [91.533291] [019/130] (908s left) kms_chamelium_hpd (dp-hpd-storm-disable) [91.896727] Subtest dp-hpd-storm-disable: SKIP (0.000s) [92.787041] [020/130] (907s left) kms_flip (wf_vblank-ts-check-interruptible) [92.873107] Starting subtest: wf_vblank-ts-check-interruptible [92.875445] Starting dynamic subtest: A-eDP1 [101.893564] Dynamic subtest A-eDP1: SUCCESS (9.018s) [101.899238] Starting dynamic subtest: B-eDP1 [110.852426] Dynamic subtest B-eDP1: SUCCESS (8.958s) [110.858510] Starting dynamic subtest: C-eDP1 [119.803044] Dynamic subtest C-eDP1: SUCCESS (8.949s) [119.811043] Starting dynamic subtest: D-eDP1 [128.760734] Dynamic subtest D-eDP1: SUCCESS (8.958s) [128.765431] Subtest wf_vblank-ts-check-interruptible: SUCCESS (35.891s) [129.992707] [021/130] (869s left) syncobj_timeline (invalid-wait-illegal-handle) [130.044723] Starting subtest: invalid-wait-illegal-handle [130.047067] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s) [130.088218] [022/130] (869s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-msflip-blt) [130.180915] Starting subtest: fbcpsr-1p-primscrn-indfb-msflip-blt [135.056369] Subtest fbcpsr-1p-primscrn-indfb-msflip-blt: SUCCESS (4.878s) [135.154919] [023/130] (864s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers) [135.241783] Starting subtest: plane-upscale-factor-0-25-with-modifiers [135.244178] Starting dynamic subtest: pipe-A [135.579825] Dynamic subtest pipe-A: SUCCESS (0.338s) [135.585566] Starting dynamic subtest: pipe-B [137.061416] Dynamic subtest pipe-B: SUCCESS (1.481s) [137.069454] Starting dynamic subtest: pipe-C [138.533883] Dynamic subtest pipe-C: SUCCESS (1.472s) [138.540870] Starting dynamic subtest: pipe-D [140.005653] Dynamic subtest pipe-D: SUCCESS (1.471s) [140.008223] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.764s) [141.254133] [024/130] (858s left) kms_cdclk (mode-transition-all-outputs) [141.338935] Starting subtest: mode-transition-all-outputs [141.625680] Subtest mode-transition-all-outputs: SKIP (0.284s) [142.533646] [025/130] (857s left) gem_exec_schedule (manyslice) [142.601218] Starting subtest: manyslice [142.603194] Starting dynamic subtest: rcs0 [146.219614] Dynamic subtest rcs0: SUCCESS (3.627s) [146.227027] Starting dynamic subtest: bcs0 [151.834950] Dynamic subtest bcs0: SUCCESS (5.615s) [151.842627] Starting dynamic subtest: vcs0 [156.405813] Dynamic subtest vcs0: SUCCESS (4.571s) [156.411487] Starting dynamic subtest: vcs1 [161.465726] Dynamic subtest vcs1: SUCCESS (5.059s) [161.473784] Starting dynamic subtest: vecs0 [167.027183] Dynamic subtest vecs0: SUCCESS (5.561s) [167.038157] Starting dynamic subtest: ccs0 [172.179345] Dynamic subtest ccs0: SUCCESS (5.152s) [172.181250] Subtest manyslice: SUCCESS (29.587s) [172.491146] [026/130] (827s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render) [172.584444] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render [172.588710] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s) [172.678618] [027/130] (827s left) gem_userptr_blits (huge-split) [172.739352] Starting subtest: huge-split [172.746065] Subtest huge-split: SUCCESS (0.007s) [172.851951] [028/130] (827s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-pgflip-blt) [172.939649] Starting subtest: fbcpsr-1p-primscrn-shrfb-pgflip-blt [177.816519] Subtest fbcpsr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.880s) [177.915983] [029/130] (822s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted) [177.959101] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted [178.066102] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.107s) [178.118067] [030/130] (821s left) syncobj_timeline (wait-all-for-submit-delayed-submit) [178.157703] Starting subtest: wait-all-for-submit-delayed-submit [178.259531] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.103s) [178.314143] [031/130] (821s left) gem_exec_whisper (basic-sync-all) [178.374353] Starting subtest: basic-sync-all [184.435999] Subtest basic-sync-all: SUCCESS (6.063s) [184.592851] [032/130] (815s left) gem_render_copy (y-tiled-to-vebox-x-tiled) [184.651006] Starting subtest: y-tiled-to-vebox-x-tiled [184.655343] Subtest y-tiled-to-vebox-x-tiled: SKIP (0.000s) [184.807927] [033/130] (815s left) kms_vrr (seamless-rr-switch-vrr) [184.894999] Starting subtest: seamless-rr-switch-vrr [184.902330] Subtest seamless-rr-switch-vrr: SKIP (0.000s) [184.942374] [034/130] (815s left) kms_cursor_crc (cursor-sliding-512x512) [185.149325] Starting subtest: cursor-sliding-512x512 [185.153478] Subtest cursor-sliding-512x512: SKIP (0.001s) [185.256920] [035/130] (814s left) perf_pmu (module-unload) [185.322189] Starting subtest: module-unload [223.126961] Subtest module-unload: SUCCESS (37.802s) [223.142304] [036/130] (776s left) syncobj_wait (multi-wait-for-submit-submitted) [224.689067] Starting subtest: multi-wait-for-submit-submitted [224.793315] Subtest multi-wait-for-submit-submitted: SUCCESS (0.106s) [224.817181] [037/130] (775s left) gem_caching (reads) [224.867307] Subtest reads: SKIP (0.000s) [224.913494] [038/130] (775s left) syncobj_wait (invalid-reset-zero-handles) [224.970983] Starting subtest: invalid-reset-zero-handles [224.973187] Subtest invalid-reset-zero-handles: SUCCESS (0.000s) [225.028694] [039/130] (775s left) gem_exec_fence (basic-wait-all) [225.089928] Starting subtest: basic-wait-all [225.187238] Subtest basic-wait-all: SUCCESS (0.101s) [227.421794] [040/130] (772s left) syncobj_basic (bad-destroy) [227.470135] Starting subtest: bad-destroy [227.472135] Subtest bad-destroy: SUCCESS (0.000s) [227.534691] [041/130] (772s left) sw_sync (sync_merge_invalid) [227.560720] Starting subtest: sync_merge_invalid [227.578998] Subtest sync_merge_invalid: SUCCESS (0.018s) [227.608314] [042/130] (772s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-fully-sf) [232.768274] Starting subtest: pr-overlay-plane-move-continuous-exceed-fully-sf [232.773633] Subtest pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.004s) [233.671582] [043/130] (766s left) kms_color (invalid-gamma-lut-sizes) [233.754923] Starting subtest: invalid-gamma-lut-sizes [233.757251] Starting dynamic subtest: pipe-A [234.042260] Dynamic subtest pipe-A: SUCCESS (0.284s) [234.049264] Starting dynamic subtest: pipe-B [234.051584] Dynamic subtest pipe-B: SUCCESS (0.001s) [234.058405] Starting dynamic subtest: pipe-C [234.060638] Dynamic subtest pipe-C: SUCCESS (0.000s) [234.066319] Starting dynamic subtest: pipe-D [234.068206] Dynamic subtest pipe-D: SUCCESS (0.000s) [234.070053] Subtest invalid-gamma-lut-sizes: SUCCESS (0.286s) [234.951655] [044/130] (765s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions) [235.059496] Starting subtest: cursor-vs-flip-atomic-transitions [264.030187] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (28.971s) [264.908054] [045/130] (735s left) kms_big_fb (linear-8bpp-rotate-180) [265.004733] Starting subtest: linear-8bpp-rotate-180 [265.972297] Subtest linear-8bpp-rotate-180: SUCCESS (0.967s) [266.081048] [046/130] (734s left) kms_addfb_basic (clobberred-modifier) [266.132674] Starting subtest: clobberred-modifier [266.137238] Subtest clobberred-modifier: SKIP (0.000s) [266.235168] [047/130] (734s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu) [266.332975] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu [271.007124] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (4.676s) [271.095483] [048/130] (729s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move) [271.201542] Starting subtest: psr-1p-primscrn-spr-indfb-move [276.513518] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (5.313s) [276.610369] [049/130] (723s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf) [281.728943] Starting subtest: fbc-psr2-cursor-plane-update-sf [281.731598] Starting dynamic subtest: pipe-A-eDP-1 [282.602671] Dynamic subtest pipe-A-eDP-1: SKIP (0.870s) [282.608854] Starting dynamic subtest: pipe-B-eDP-1 [283.818149] Dynamic subtest pipe-B-eDP-1: SKIP (1.214s) [283.822897] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (2.087s) [285.064527] [050/130] (715s left) gem_bad_reloc (negative-reloc-bltcopy) [285.115727] Subtest negative-reloc-bltcopy: SKIP (0.000s) [285.158349] [051/130] (715s left) kms_frontbuffer_tracking (psr-rgb101010-draw-render) [285.243299] Starting subtest: psr-rgb101010-draw-render [290.126244] Subtest psr-rgb101010-draw-render: SUCCESS (4.884s) [290.223708] [052/130] (710s left) kms_prop_blob (blob-prop-core) [290.277299] Starting subtest: blob-prop-core [290.279623] Subtest blob-prop-core: SUCCESS (0.000s) [290.338724] [053/130] (710s left) perf (i915-ref-count) [290.393066] Starting subtest: i915-ref-count [290.440080] Subtest i915-ref-count: SUCCESS (0.045s) [290.471397] [054/130] (709s left) kms_content_protection (legacy) [290.608968] Starting subtest: legacy [294.586606] Subtest legacy: SKIP (3.974s) [295.818145] [055/130] (704s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-wc) [295.918483] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-wc [295.922665] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [295.984008] [056/130] (704s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs) [296.072864] Starting subtest: bad-rotation-90-y-tiled-gen12-rc-ccs [296.075223] Starting dynamic subtest: pipe-A-eDP-1 [296.098063] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [296.105947] Starting dynamic subtest: pipe-B-eDP-1 [296.127735] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [296.134092] Starting dynamic subtest: pipe-C-eDP-1 [296.156023] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [296.162223] Starting dynamic subtest: pipe-D-eDP-1 [296.184367] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [296.188749] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs: SKIP (0.003s) [298.442637] [057/130] (702s left) gem_mmap_gtt (basic-read) [298.490431] Subtest basic-read: SKIP (0.000s) [298.532342] [058/130] (701s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt) [298.636601] Starting subtest: fbcpsr-rgb101010-draw-blt [303.378483] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (4.744s) [303.479418] [059/130] (696s left) syncobj_wait (single-wait-all-submitted) [303.515422] Starting subtest: single-wait-all-submitted [303.617245] Subtest single-wait-all-submitted: SUCCESS (0.103s) [303.668676] [060/130] (696s left) gem_exec_suspend (basic-s3-devices) [303.718729] Starting subtest: basic-S3-devices [303.721149] Starting dynamic subtest: smem [314.341287] Dynamic subtest smem: SUCCESS (10.621s) [314.344476] Subtest basic-S3-devices: SUCCESS (10.622s) [314.501416] [061/130] (686s left) gem_pxp (verify-pxp-stale-ctx-execution) [317.080059] Subtest verify-pxp-stale-ctx-execution: SKIP (0.000s) [317.121663] [062/130] (683s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling) [317.216059] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling [317.218480] Starting dynamic subtest: pipe-A-default-mode [320.082793] Dynamic subtest pipe-A-default-mode: SUCCESS (2.865s) [320.085310] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.866s) [320.967344] [063/130] (679s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs) [321.042865] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs [321.045253] Starting dynamic subtest: pipe-A-eDP-1 [321.070436] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [321.078820] Starting dynamic subtest: pipe-B-eDP-1 [321.100186] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [321.107215] Starting dynamic subtest: pipe-C-eDP-1 [321.129192] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [321.135619] Starting dynamic subtest: pipe-D-eDP-1 [321.157844] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [321.162307] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs: SKIP (0.003s) [323.398718] [064/130] (677s left) dmabuf_sync_file (import-multiple-read-only) [323.432261] Starting subtest: import-multiple-read-only [323.434555] Subtest import-multiple-read-only: SUCCESS (0.002s) [323.464902] [065/130] (677s left) gen9_exec_parse (unaligned-access) [323.512763] Subtest unaligned-access: SKIP (0.000s) [323.558629] [066/130] (677s left) gem_exec_flush (basic-uc-ro-default) [323.606796] Starting subtest: basic-uc-ro-default [329.037514] Subtest basic-uc-ro-default: SUCCESS (5.423s) [329.184780] [067/130] (671s left) perf_pmu (rc6) [329.210870] Starting subtest: rc6 [329.213764] Starting dynamic subtest: gt0 [335.574979] Dynamic subtest gt0: SUCCESS (6.362s) [335.585542] Starting dynamic subtest: runtime-pm-gt0 [343.285976] Dynamic subtest runtime-pm-gt0: SUCCESS (7.710s) [343.295727] Starting dynamic subtest: runtime-pm-long-gt0 [355.715503] Dynamic subtest runtime-pm-long-gt0: SUCCESS (12.428s) [355.726442] Starting dynamic subtest: other-idle-gt0 [362.055961] Dynamic subtest other-idle-gt0: SUCCESS (6.340s) [362.066116] Starting dynamic subtest: gt1 [368.396826] Dynamic subtest gt1: SUCCESS (6.340s) [368.406672] Starting dynamic subtest: runtime-pm-gt1 [375.835353] Dynamic subtest runtime-pm-gt1: SUCCESS (7.437s) [375.844176] Starting dynamic subtest: runtime-pm-long-gt1 [388.269272] Dynamic subtest runtime-pm-long-gt1: SUCCESS (12.432s) [388.278998] Starting dynamic subtest: other-idle-gt1 [394.611708] Dynamic subtest other-idle-gt1: SUCCESS (6.341s) [394.614677] Subtest rc6: SUCCESS (65.398s) [395.714805] [068/130] (604s left) kms_big_fb (4-tiled-8bpp-rotate-180) [395.805958] Starting subtest: 4-tiled-8bpp-rotate-180 [396.771533] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (0.968s) [396.849308] [069/130] (603s left) gem_ctx_param (invalid-get-no-zeromap) [396.888376] Starting subtest: invalid-get-no-zeromap [396.890790] Subtest invalid-get-no-zeromap: SUCCESS (0.001s) [396.928413] [070/130] (603s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-upscaling) [397.020089] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-upscaling [397.022626] Starting dynamic subtest: pipe-A-default-mode [397.304522] Dynamic subtest pipe-A-default-mode: SKIP (0.280s) [397.309777] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-upscaling: SKIP (0.281s) [398.198753] [071/130] (602s left) kms_vblank (wait-forked-busy) [398.289969] Starting subtest: wait-forked-busy [398.292695] Starting dynamic subtest: pipe-A-eDP-1 [400.157545] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.865s) [400.171274] Starting dynamic subtest: pipe-D-eDP-1 [402.783049] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.624s) [402.785918] Subtest wait-forked-busy: SUCCESS (4.492s) [403.638040] [072/130] (597s left) kms_plane_alpha_blend (alpha-transparent-fb) [403.727808] Starting subtest: alpha-transparent-fb [403.999173] Starting dynamic subtest: pipe-A-eDP-1 [404.550332] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.550s) [404.557403] Starting dynamic subtest: pipe-D-eDP-1 [405.953246] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.400s) [405.955984] Subtest alpha-transparent-fb: SUCCESS (2.223s) [406.835710] [073/130] (593s left) kms_invalid_mode (clock-too-high) [406.921295] Starting subtest: clock-too-high [406.923675] Starting dynamic subtest: pipe-A-eDP-1 [406.927903] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [406.936365] Starting dynamic subtest: pipe-B-eDP-1 [406.941219] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [406.948033] Starting dynamic subtest: pipe-C-eDP-1 [406.952815] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [406.959427] Starting dynamic subtest: pipe-D-eDP-1 [406.964233] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [406.969070] Subtest clock-too-high: SKIP (0.003s) [406.982865] [074/130] (593s left) drm_fdinfo (memory-info-idle) [407.014890] Starting subtest: memory-info-idle [407.017104] Starting dynamic subtest: smem0 [407.056444] Dynamic subtest smem0: SUCCESS (0.042s) [407.059035] Subtest memory-info-idle: SUCCESS (0.043s) [407.084832] [075/130] (593s left) gem_softpin (full) [407.127624] Starting subtest: full [407.132894] Subtest full: SUCCESS (0.006s) [407.218357] [076/130] (593s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs) [407.298797] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs [407.301073] Starting dynamic subtest: pipe-A-eDP-1 [407.321624] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [407.330322] Starting dynamic subtest: pipe-B-eDP-1 [407.350182] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [407.357356] Starting dynamic subtest: pipe-C-eDP-1 [407.376968] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [407.386408] Starting dynamic subtest: pipe-D-eDP-1 [407.407363] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [407.409784] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs: SUCCESS (0.004s) [409.588854] [077/130] (591s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area) [414.703349] Starting subtest: psr2-overlay-primary-update-sf-dmg-area [414.706360] Starting dynamic subtest: pipe-A-eDP-1 [421.424120] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.718s) [421.433775] Starting dynamic subtest: pipe-B-eDP-1 [428.138955] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.711s) [428.142118] Subtest psr2-overlay-primary-update-sf-dmg-area: SUCCESS (13.433s) [428.981820] [078/130] (571s left) kms_frontbuffer_tracking (fbcpsr-2p-shrfb-fliptrack-mmap-gtt) [429.080446] Starting subtest: fbcpsr-2p-shrfb-fliptrack-mmap-gtt [429.084985] Subtest fbcpsr-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s) [429.124841] [079/130] (571s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt) [429.223115] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt [429.227335] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [429.267261] [080/130] (571s left) kms_big_fb (4-tiled-16bpp-rotate-180) [429.363497] Starting subtest: 4-tiled-16bpp-rotate-180 [430.429911] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.066s) [430.515944] [081/130] (570s left) gem_linear_blits (normal) [430.952467] Starting subtest: normal [433.352825] Subtest normal: SUCCESS (2.398s) [433.475170] [082/130] (567s left) gem_busy (parallel) [433.698957] Starting subtest: parallel [433.701875] Starting dynamic subtest: rcs0 [435.366724] Dynamic subtest rcs0: SUCCESS (1.665s) [435.376292] Starting dynamic subtest: bcs0 [437.350398] Dynamic subtest bcs0: SUCCESS (1.983s) [437.361483] Starting dynamic subtest: vcs0 [439.399524] Dynamic subtest vcs0: SUCCESS (2.048s) [439.410550] Starting dynamic subtest: vcs1 [441.382314] Dynamic subtest vcs1: SUCCESS (1.982s) [441.390838] Starting dynamic subtest: vecs0 [443.366616] Dynamic subtest vecs0: SUCCESS (1.983s) [443.377729] Starting dynamic subtest: ccs0 [445.350392] Dynamic subtest ccs0: SUCCESS (1.983s) [445.353506] Subtest parallel: SUCCESS (11.650s) [445.537948] [083/130] (555s left) perf (non-system-wide-paranoid) [445.612381] Starting subtest: non-system-wide-paranoid [445.638428] Subtest non-system-wide-paranoid: SUCCESS (0.026s) [445.667112] [084/130] (555s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset) [445.757063] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset [445.770366] Subtest 2x-flip-vs-dpms-off-vs-modeset: SKIP (0.013s) [445.801224] [085/130] (555s left) gem_render_copy (y-tiled-ccs-to-y-tiled) [445.851060] Starting subtest: y-tiled-ccs-to-y-tiled [445.855354] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s) [445.987427] [086/130] (554s left) kms_plane (planar-pixel-format-settings) [446.068948] Starting subtest: planar-pixel-format-settings [446.096058] Subtest planar-pixel-format-settings: SUCCESS (0.025s) [446.142681] [087/130] (554s left) kms_busy (extended-modeset-hang-newfb-with-reset) [446.228726] Starting subtest: extended-modeset-hang-newfb-with-reset [446.231048] Starting dynamic subtest: pipe-A [461.505726] Dynamic subtest pipe-A: SUCCESS (15.275s) [461.515668] Starting dynamic subtest: pipe-D [477.378442] Dynamic subtest pipe-D: SUCCESS (15.867s) [477.380931] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (31.147s) [478.262929] [088/130] (522s left) i915_selftest (live) [481.743761] Starting subtest: live [481.747048] Starting dynamic subtest: sanitycheck [484.221506] Dynamic subtest sanitycheck: SUCCESS (2.478s) [484.230585] Starting dynamic subtest: uncore [486.600143] Dynamic subtest uncore: SUCCESS (2.378s) [486.608323] Starting dynamic subtest: workarounds [491.997513] Warning: kernel log ringbuffer underflow, some records lost. [509.891448] Killing the test because the kernel is tainted. [510.809804] Aborting: Kernel badly tainted (0x240, 0x200) (check dmesg for details): TAINT_WARN: WARN_ON has happened. [510.812146] Closing watchdogs Done.