[94.999156] Initializing watchdogs
[94.999309]   /dev/watchdog0
[95.018663] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300)
[95.026856] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[95.030783] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[95.033904] [001/131] (960s left) syncobj_eventfd (invalid-bad-pad)
[95.122624] Starting subtest: invalid-bad-pad
[95.123321] Subtest invalid-bad-pad: SUCCESS (0.000s)
[95.247316] [002/131] (960s left) tools_test (tools_test)
[95.305255] Starting subtest: tools_test
[95.411678] Subtest tools_test: SUCCESS (0.113s)
[95.510036] [003/131] (960s left) kms_psr2_su (frontbuffer-xrgb8888)
[95.563638] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[95.620585] [004/131] (960s left) gem_userptr_blits (sync-unmap-cycles)
[95.691578] Starting subtest: sync-unmap-cycles
[101.067482] Subtest sync-unmap-cycles: SUCCESS (5.374s)
[101.233080] [005/131] (954s left) kms_pipe_stress (stress-xrgb8888-ytiled)
[101.531286] Starting subtest: stress-xrgb8888-ytiled
[101.532594] Subtest stress-xrgb8888-ytiled: SKIP (0.000s)
[101.730255] [006/131] (954s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs)
[101.783902] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[101.844944] [007/131] (953s left) api_intel_allocator (gem-pool)
[101.900627] Starting subtest: gem-pool
[101.904437] Subtest gem-pool: SUCCESS (0.004s)
[102.067853] [008/131] (953s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[102.373063] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[102.374591] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[102.780987] [009/131] (953s left) kms_atomic_interruptible (universal-setplane-primary)
[103.081297] Starting subtest: universal-setplane-primary
[103.082083] Starting dynamic subtest: pipe-A-HDMI-A-1
[109.419799] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.336s)
[109.420623] Subtest universal-setplane-primary: SUCCESS (6.338s)
[109.940504] [010/131] (945s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-move)
[110.246598] Starting subtest: fbc-1p-primscrn-spr-indfb-move
[112.914615] Subtest fbc-1p-primscrn-spr-indfb-move: SUCCESS (2.668s)
[113.377312] [011/131] (942s left) gem_eio (in-flight-contexts-1us)
[113.439125] Starting subtest: in-flight-contexts-1us
[116.828243] Subtest in-flight-contexts-1us: SUCCESS (3.389s)
[117.483951] [012/131] (938s left) gem_exec_balancer (semaphore)
[117.545904] Subtest semaphore: SKIP (0.000s)
[117.662081] [013/131] (938s left) kms_chamelium_hpd (hdmi-hpd)
[118.022432] Subtest hdmi-hpd: SKIP (0.000s)
[118.326557] [014/131] (937s left) kms_flip (wf_vblank-ts-check)
[118.627441] Starting subtest: wf_vblank-ts-check
[118.628210] Starting dynamic subtest: A-VGA1
[126.744519] Dynamic subtest A-VGA1: SUCCESS (8.116s)
[126.754879] Starting dynamic subtest: B-VGA1
[134.753864] Dynamic subtest B-VGA1: SUCCESS (8.007s)
[134.764999] Starting dynamic subtest: A-HDMI-A1
[142.927126] Dynamic subtest A-HDMI-A1: SUCCESS (8.171s)
[142.938151] Starting dynamic subtest: B-HDMI-A1
[151.132318] Dynamic subtest B-HDMI-A1: SUCCESS (8.204s)
[151.133646] Subtest wf_vblank-ts-check: SUCCESS (32.505s)
[151.697990] [015/131] (904s left) gem_exec_reloc (basic-gtt)
[151.757231] Starting subtest: basic-gtt
[151.761237] Subtest basic-gtt: SUCCESS (0.004s)
[152.392926] [016/131] (903s left) gem_exec_schedule (reorder-wide)
[152.464999] Subtest reorder-wide: SKIP (0.000s)
[152.696571] [017/131] (903s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs-cc)
[152.749521] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs-cc: SKIP (0.000s)
[152.803684] [018/131] (903s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[153.096894] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[153.098231] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[153.512789] [019/131] (902s left) perf (polling)
[153.656369] Subtest polling: SKIP (0.000s)
[153.703760] [020/131] (902s left) gem_userptr_blits (probe)
[153.785153] Starting subtest: probe
[153.977892] Subtest probe: SUCCESS (0.193s)
[154.123755] [021/131] (902s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180)
[154.421722] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180
[154.423131] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s)
[154.822112] [022/131] (901s left) gem_mmap_offset (pf-nonblock)
[154.877248] Starting subtest: pf-nonblock
[154.880619] Subtest pf-nonblock: SUCCESS (0.003s)
[155.039978] [023/131] (901s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs)
[155.093325] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.000s)
[155.152217] [024/131] (901s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[155.444827] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[155.446356] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[155.854986] [025/131] (900s left) core_getstats (basic)
[155.912024] Starting subtest: basic
[155.912877] Subtest basic: SUCCESS (0.000s)
[156.045196] [026/131] (900s left) core_getclient (basic)
[156.096707] Starting subtest: basic
[156.097502] Subtest basic: SUCCESS (0.000s)
[156.219793] [027/131] (900s left) syncobj_timeline (multi-wait-all-available-submitted)
[156.276037] Starting subtest: multi-wait-all-available-submitted
[156.277673] Subtest multi-wait-all-available-submitted: SUCCESS (0.001s)
[156.402783] [028/131] (900s left) gem_exec_reloc (basic-write-wc)
[156.461017] Starting subtest: basic-write-wc
[156.464436] Subtest basic-write-wc: SUCCESS (0.003s)
[157.103536] [029/131] (899s left) kms_invalid_mode (clock-too-high)
[157.395860] Starting subtest: clock-too-high
[157.396884] Starting dynamic subtest: pipe-A-HDMI-A-1
[157.473532] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.079s)
[157.484662] Starting dynamic subtest: pipe-B-HDMI-A-1
[157.485352] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[157.485930] Subtest clock-too-high: SUCCESS (0.082s)
[157.858492] [030/131] (898s left) gem_mmap_offset (bad-object)
[157.915669] Starting subtest: bad-object
[157.917397] Subtest bad-object: SUCCESS (0.002s)
[158.056581] [031/131] (898s left) syncobj_timeline (wait-all-delayed-signal)
[158.113804] Starting subtest: wait-all-delayed-signal
[158.215704] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[158.342910] [032/131] (898s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[158.645958] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[158.648759] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.001s)
[159.055925] [033/131] (897s left) gem_exec_suspend (basic-s3)
[159.121966] Starting subtest: basic-S3
[159.123076] Starting dynamic subtest: smem
[176.106312] Dynamic subtest smem: SUCCESS (1.377s)
[176.107657] Subtest basic-S3: SUCCESS (1.378s)
[184.359019] [034/131] (880s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite)
[184.686955] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite
[184.688319] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[185.095994] [035/131] (880s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-render)
[185.394063] Starting subtest: psr-2p-primscrn-spr-indfb-draw-render
[185.395335] Subtest psr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[185.797186] [036/131] (879s left) kms_chamelium_frames (hdmi-crc-multiple)
[186.164080] Subtest hdmi-crc-multiple: SKIP (0.000s)
[186.445483] [037/131] (878s left) gem_exec_fence (syncobj-import)
[186.681984] Starting subtest: syncobj-import
[186.684583] Subtest syncobj-import: SUCCESS (0.002s)
[187.075184] [FACT gem_exec_fence (syncobj-import)] new: kernel.kmod_is_loaded.vgem: true
[187.078890] [038/131] (878s left) kms_legacy_colorkey (basic)
[187.367823] Starting subtest: basic
[187.368725] Starting dynamic subtest: pipe-A
[187.369630] Dynamic subtest pipe-A: SUCCESS (0.000s)
[187.382981] Starting dynamic subtest: pipe-B
[187.384281] Dynamic subtest pipe-B: SUCCESS (0.000s)
[187.385408] Subtest basic: SUCCESS (0.002s)
[187.770918] [039/131] (877s left) gem_softpin (allocator-nopin-reserve)
[187.829119] Subtest allocator-nopin-reserve: SKIP (0.000s)
[187.953119] [040/131] (877s left) perf_pmu (enable-race)
[188.006539] Starting subtest: enable-race
[188.007287] Starting dynamic subtest: rcs0
[188.008736] Dynamic subtest rcs0: SKIP (0.000s)
[188.024006] Starting dynamic subtest: bcs0
[188.026305] Dynamic subtest bcs0: SKIP (0.000s)
[188.047420] Starting dynamic subtest: vcs0
[188.050050] Dynamic subtest vcs0: SKIP (0.000s)
[188.052226] Subtest enable-race: SKIP (0.002s)
[188.138603] [041/131] (877s left) syncobj_timeline (signal-point-0)
[188.195443] Starting subtest: signal-point-0
[188.196176] Subtest signal-point-0: SUCCESS (0.000s)
[188.320905] [042/131] (877s left) gem_tiled_wb
[196.257694] [043/131] (869s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs-cc)
[196.311961] Subtest random-ccs-data-y-tiled-gen12-rc-ccs-cc: SKIP (0.000s)
[196.383255] [044/131] (869s left) gem_ctx_param (set-priority-invalid-size)
[196.437389] Subtest set-priority-invalid-size: SKIP (0.000s)
[196.576469] [045/131] (869s left) kms_color_pipeline (plane-ctm3x4-lut1d)
[196.873474] Starting subtest: plane-ctm3x4-lut1d
[197.148174] Subtest plane-ctm3x4-lut1d: SKIP (0.275s)
[197.684921] [046/131] (868s left) kms_cursor_legacy (2x-long-cursor-vs-flip-atomic)
[197.984599] Starting subtest: 2x-long-cursor-vs-flip-atomic
[197.987066] Subtest 2x-long-cursor-vs-flip-atomic: SKIP (0.001s)
[198.400487] [047/131] (867s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[198.705790] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt
[200.545035] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SUCCESS (1.839s)
[200.998095] [048/131] (864s left) kms_feature_discovery (display-1x)
[201.287774] Starting subtest: display-1x
[201.288549] Subtest display-1x: SUCCESS (0.000s)
[201.694321] [049/131] (864s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[202.003131] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[202.006112] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[202.405703] [050/131] (863s left) i915_drm_fdinfo (most-busy-idle-check-all)
[202.465679] Subtest most-busy-idle-check-all: SKIP (0.000s)
[202.521009] [051/131] (863s left) kms_big_fb (x-tiled-32bpp-rotate-270)
[202.820143] Starting subtest: x-tiled-32bpp-rotate-270
[202.841040] Subtest x-tiled-32bpp-rotate-270: SKIP (0.021s)
[203.266734] [052/131] (862s left) gem_exec_schedule (u-submit-early-slice)
[203.335213] Subtest u-submit-early-slice: SKIP (0.000s)
[203.573651] [053/131] (862s left) gem_pxp (regular-baseline-src-copy-readible)
[206.142456] Starting subtest: regular-baseline-src-copy-readible
[206.144106] Subtest regular-baseline-src-copy-readible: SKIP (0.000s)
[206.268266] [054/131] (859s left) gem_exec_balancer (full-late-pulse)
[206.321321] Subtest full-late-pulse: SKIP (0.000s)
[206.464209] [055/131] (859s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-blt)
[206.761346] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-blt
[206.762561] Subtest fbc-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[207.181813] [056/131] (859s left) fbdev (read)
[207.251286] Starting subtest: read
[207.639315] Subtest read: SUCCESS (0.389s)
[207.750985] [057/131] (858s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[208.045657] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-cpu
[208.046992] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[208.449728] [058/131] (857s left) kms_rotation_crc (multiplane-rotation-cropping-top)
[208.750339] Starting subtest: multiplane-rotation-cropping-top
[208.752007] Subtest multiplane-rotation-cropping-top: SKIP (0.000s)
[209.165595] [059/131] (857s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-blt)
[209.461937] Starting subtest: psr-1p-offscreen-pri-indfb-draw-blt
[209.463086] Subtest psr-1p-offscreen-pri-indfb-draw-blt: SKIP (0.000s)
[209.879244] [060/131] (856s left) i915_selftest (mock)
[210.832585] Starting subtest: mock
[210.837933] Starting dynamic subtest: sanitycheck
[211.944735] Dynamic subtest sanitycheck: SUCCESS (1.112s)
[211.957183] Starting dynamic subtest: shmem
[213.052878] Dynamic subtest shmem: SUCCESS (1.107s)
[213.064566] Starting dynamic subtest: fence
[221.657011] Dynamic subtest fence: SUCCESS (8.605s)
[221.668585] Starting dynamic subtest: scatterlist
[223.752995] Dynamic subtest scatterlist: SUCCESS (2.095s)
[223.770151] Starting dynamic subtest: syncmap
[226.906082] Dynamic subtest syncmap: SUCCESS (3.152s)
[226.918459] Starting dynamic subtest: uncore
[228.005109] Dynamic subtest uncore: SUCCESS (1.098s)
[228.017521] Starting dynamic subtest: ring
[229.097101] Dynamic subtest ring: SUCCESS (1.091s)
[229.108862] Starting dynamic subtest: engine
[230.192884] Dynamic subtest engine: SUCCESS (1.095s)
[230.205282] Starting dynamic subtest: timelines
[236.393963] Dynamic subtest timelines: SUCCESS (6.201s)
[236.406579] Starting dynamic subtest: requests
[239.649043] Dynamic subtest requests: SUCCESS (3.254s)
[239.660522] Starting dynamic subtest: objects
[240.821039] Dynamic subtest objects: SUCCESS (1.171s)
[240.832781] Starting dynamic subtest: phys
[242.032001] Dynamic subtest phys: SUCCESS (1.210s)
[242.044534] Starting dynamic subtest: dmabuf
[243.253029] Dynamic subtest dmabuf: SUCCESS (1.220s)
[243.265501] Starting dynamic subtest: vma
[254.845978] Dynamic subtest vma: SUCCESS (11.592s)
[254.857644] Starting dynamic subtest: evict
[257.348514] Dynamic subtest evict: SUCCESS (2.502s)
[257.361092] Starting dynamic subtest: gtt
[261.667069] Dynamic subtest gtt: SUCCESS (4.317s)
[261.683007] Starting dynamic subtest: hugepages
[263.146023] Dynamic subtest hugepages: SUCCESS (1.477s)
[263.162326] Starting dynamic subtest: memory_region
[268.219835] Dynamic subtest memory_region: SUCCESS (5.073s)
[268.220790] Subtest mock: SUCCESS (57.394s)
[268.256238] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[268.257524] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[268.259971] [061/131] (798s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf)
[270.300028] Subtest fbc-psr2-cursor-plane-move-continuous-sf: SKIP (0.000s)
[270.504735] [FACT kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[270.506445] [FACT kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf)] new: kernel.kmod_is_loaded.i915: true
[270.509914] [062/131] (796s left) gem_render_copy_redux (normal)
[270.578212] Starting subtest: normal
[271.134195] Subtest normal: SUCCESS (0.557s)
[271.304098] [063/131] (795s left) gem_exec_reloc (basic-cpu-wc-noreloc)
[271.362944] Starting subtest: basic-cpu-wc-noreloc
[271.365325] Subtest basic-cpu-wc-noreloc: SUCCESS (0.002s)
[272.018520] [064/131] (794s left) gem_ctx_param (invalid-set-no-zeromap)
[272.073297] Starting subtest: invalid-set-no-zeromap
[272.074189] Subtest invalid-set-no-zeromap: SUCCESS (0.000s)
[272.200400] [065/131] (794s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite)
[272.496919] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite
[272.498302] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[272.900121] [066/131] (793s left) i915_pm_rps (reset)
[272.961039] Starting subtest: reset
[277.497069] Subtest reset: SUCCESS (4.536s)
[277.664327] [067/131] (789s left) kms_async_flips (async-flip-with-page-flip-events-linear)
[277.960549] Starting subtest: async-flip-with-page-flip-events-linear
[278.105593] Subtest async-flip-with-page-flip-events-linear: SKIP (0.146s)
[278.630324] [068/131] (788s left) perf_pmu (module-unload)
[278.698862] Starting subtest: module-unload
[285.027723] Subtest module-unload: FAIL (6.308s)
[285.056926] [FACT perf_pmu (module-unload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[285.058197] [FACT perf_pmu (module-unload)] deleted: kernel.kmod_is_loaded.i915: true
[285.060642] [069/131] (781s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[287.063055] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[287.064706] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[287.510788] [FACT kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[287.512443] [FACT kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)] new: kernel.kmod_is_loaded.i915: true
[287.516845] [070/131] (779s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[287.578375] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[287.680998] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.102s)
[287.823969] [071/131] (779s left) kms_cursor_crc (cursor-random-256x85)
[288.123211] Starting subtest: cursor-random-256x85
[288.187397] Subtest cursor-random-256x85: SKIP (0.061s)
[288.599164] [072/131] (778s left) kms_psr (psr-sprite-plane-move)
[288.894430] Subtest psr-sprite-plane-move: SKIP (0.000s)
[289.091610] [073/131] (778s left) kms_psr (fbc-pr-sprite-plane-onoff)
[289.381199] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[289.572917] [074/131] (777s left) kms_pm_rpm (pm-tiling)
[301.067910] Subtest pm-tiling: SKIP (0.000s)
[301.266453] [075/131] (765s left) gem_userptr_blits (invalid-null-pointer)
[301.326588] Starting subtest: invalid-null-pointer
[301.330250] Subtest invalid-null-pointer: SUCCESS (0.004s)
[301.521211] [076/131] (765s left) kms_content_protection (lic-type-1)
[301.830944] Starting subtest: lic-type-1
[301.832110] Subtest lic-type-1: SKIP (0.000s)
[302.241418] [077/131] (765s left) kms_atomic (plane-immutable-zpos)
[302.533065] Starting subtest: plane-immutable-zpos
[302.534126] Starting dynamic subtest: pipe-A-HDMI-A-1
[303.037005] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.503s)
[303.037738] Subtest plane-immutable-zpos: SUCCESS (0.506s)
[303.552909] [078/131] (763s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[303.852400] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[303.853886] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.002s)
[304.265968] [079/131] (763s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format)
[304.558861] Starting subtest: plane-upscale-factor-0-25-with-pixel-format
[304.559644] Starting dynamic subtest: pipe-A
[304.561884] Dynamic subtest pipe-A: SKIP (0.001s)
[304.574418] Starting dynamic subtest: pipe-B
[304.576504] Dynamic subtest pipe-B: SKIP (0.001s)
[304.577842] Subtest plane-upscale-factor-0-25-with-pixel-format: SKIP (0.005s)
[304.965454] [080/131] (762s left) kms_psr (pr-sprite-mmap-cpu)
[305.257695] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[305.459267] [081/131] (762s left) gem_ctx_persistence (legacy-engines-cleanup)
[305.521617] Subtest legacy-engines-cleanup: SKIP (0.000s)
[305.577663] [082/131] (762s left) kms_cursor_crc (cursor-tearing-framebuffer-change)
[305.869948] Starting subtest: cursor-tearing-framebuffer-change
[305.873214] Starting dynamic subtest: pipe-A-HDMI-A-1
[306.212866] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.340s)
[306.225197] Starting dynamic subtest: pipe-B-HDMI-A-1
[306.575934] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.361s)
[306.576681] Subtest cursor-tearing-framebuffer-change: SUCCESS (0.707s)
[307.105406] [083/131] (760s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[307.398332] Starting subtest: 2x-cursor-vs-flip-atomic
[307.400073] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.002s)
[307.804402] [084/131] (759s left) kms_cursor_crc (cursor-random-32x10)
[308.096766] Starting subtest: cursor-random-32x10
[308.153337] Subtest cursor-random-32x10: SKIP (0.055s)
[308.569632] [085/131] (759s left) kms_psr (fbc-psr-primary-mmap-gtt)
[308.862534] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.000s)
[309.063023] [086/131] (758s left) kms_big_fb (linear-8bpp-rotate-0)
[309.363056] Starting subtest: linear-8bpp-rotate-0
[310.580614] Subtest linear-8bpp-rotate-0: SUCCESS (1.216s)
[311.031530] [087/131] (756s left) gem_create (create-ext-cpu-access-sanity-check)
[311.203465] Starting subtest: create-ext-cpu-access-sanity-check
[311.205197] Subtest create-ext-cpu-access-sanity-check: SKIP (0.001s)
[311.328646] [088/131] (756s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-blt)
[311.624690] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-blt
[313.127338] Subtest fbc-1p-offscreen-pri-indfb-draw-blt: SUCCESS (1.503s)
[313.578704] [089/131] (754s left) kms_pm_rpm (cursor-dpms)
[325.069116] Subtest cursor-dpms: SKIP (0.000s)
[325.263259] [090/131] (742s left) gem_lmem_swapping (verify-random-ccs)
[325.339980] Subtest verify-random-ccs: SKIP (0.000s)
[325.396906] [091/131] (742s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[325.696151] Starting subtest: flip-vs-cursor-toggle
[340.137514] Subtest flip-vs-cursor-toggle: SUCCESS (14.440s)
[340.650397] [092/131] (727s left) gem_lmem_swapping (heavy-verify-multi)
[340.715059] Subtest heavy-verify-multi: SKIP (0.000s)
[340.779025] [093/131] (727s left) i915_pm_freq_api (freq-reset)
[340.836863] Subtest freq-reset: SKIP (0.000s)
[340.893496] [094/131] (727s left) kms_big_fb (y-tiled-64bpp-rotate-90)
[341.194800] Starting subtest: y-tiled-64bpp-rotate-90
[341.197672] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s)
[341.599238] [095/131] (726s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[341.899262] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[341.900508] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[342.317814] [096/131] (726s left) kms_dirtyfb (default-dirtyfb-ioctl)
[342.613545] Starting subtest: default-dirtyfb-ioctl
[342.614298] Starting dynamic subtest: A-HDMI-A-1
[343.958339] Dynamic subtest A-HDMI-A-1: SUCCESS (1.343s)
[343.959265] Subtest default-dirtyfb-ioctl: SUCCESS (1.346s)
[344.459975] [097/131] (723s left) kms_plane_scaling (plane-downscale-factor-0-75-with-modifiers)
[344.752529] Starting subtest: plane-downscale-factor-0-75-with-modifiers
[344.753411] Starting dynamic subtest: pipe-A
[344.755415] Dynamic subtest pipe-A: SKIP (0.001s)
[344.770881] Starting dynamic subtest: pipe-B
[344.773820] Dynamic subtest pipe-B: SKIP (0.001s)
[344.775432] Subtest plane-downscale-factor-0-75-with-modifiers: SKIP (0.005s)
[345.155751] [098/131] (723s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[345.216467] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[345.285731] [099/131] (723s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[345.576295] Starting subtest: 2x-cursor-vs-flip-legacy
[345.577792] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[345.992487] [100/131] (722s left) gem_readwrite (write-bad-handle)
[346.051842] Starting subtest: write-bad-handle
[346.053211] Subtest write-bad-handle: SUCCESS (0.000s)
[346.202954] [101/131] (722s left) gem_reg_read (timestamp-monotonic)
[346.257325] Starting subtest: timestamp-monotonic
[351.145460] Subtest timestamp-monotonic: SUCCESS (4.888s)
[351.274495] [102/131] (717s left) kms_psr (fbc-psr2-cursor-plane-move)
[351.574374] Subtest fbc-psr2-cursor-plane-move: SKIP (0.000s)
[351.771879] [103/131] (716s left) kms_plane_lowres (tiling-x)
[352.066804] Starting subtest: tiling-x
[352.067661] Starting dynamic subtest: pipe-A-HDMI-A-1
[354.624733] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.556s)
[354.719369] Starting dynamic subtest: pipe-B-HDMI-A-1
[357.178911] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.470s)
[357.260772] Subtest tiling-x: SUCCESS (5.195s)
[357.824409] [104/131] (710s left) kms_force_connector_basic (force-edid)
[357.902712] Starting subtest: force-edid
[357.920159] Subtest force-edid: SUCCESS (0.018s)
[358.380602] [105/131] (710s left) kms_getfb (getfb-handle-zero)
[358.672290] Starting subtest: getfb-handle-zero
[358.673133] Subtest getfb-handle-zero: SUCCESS (0.000s)
[359.090993] [106/131] (709s left) perf (missing-sample-flags)
[359.242212] Subtest missing-sample-flags: SKIP (0.000s)
[359.299519] [107/131] (709s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen)
[359.588293] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen
[359.589816] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[360.003014] [108/131] (708s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)
[360.306873] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc
[360.308148] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[360.722022] [109/131] (708s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-pwrite)
[361.020320] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-pwrite
[361.021675] Subtest fbc-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[361.435349] [110/131] (707s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[361.733256] Starting subtest: 4-tiled-8bpp-rotate-180
[361.734677] Subtest 4-tiled-8bpp-rotate-180: SKIP (0.000s)
[362.146485] [111/131] (707s left) gem_exec_fence (syncobj-timeline-repeat)
[362.470763] Starting subtest: syncobj-timeline-repeat
[363.056418] Subtest syncobj-timeline-repeat: SUCCESS (0.587s)
[363.336049] [112/131] (705s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[363.634097] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[363.635513] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[364.044313] [113/131] (705s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled)
[364.101126] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[364.101855] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[364.226667] [114/131] (705s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-render)
[364.520655] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-render
[366.456344] Subtest fbc-1p-primscrn-cur-indfb-draw-render: SUCCESS (1.935s)
[366.906713] [115/131] (702s left) gem_exec_schedule (lateslice)
[366.975415] Subtest lateslice: SKIP (0.000s)
[367.207364] [116/131] (702s left) kms_vblank (query-idle-hang)
[367.505048] Starting subtest: query-idle-hang
[367.506351] Starting dynamic subtest: pipe-A-HDMI-A-1
[373.557666] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.051s)
[373.572260] Starting dynamic subtest: pipe-B-HDMI-A-1
[379.578250] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.018s)
[379.580492] Subtest query-idle-hang: SUCCESS (12.077s)
[380.116434] [117/131] (689s left) syncobj_wait (reset-multiple-signaled)
[380.180055] Starting subtest: reset-multiple-signaled
[380.180953] Subtest reset-multiple-signaled: SUCCESS (0.001s)
[380.319846] [118/131] (689s left) kms_flip_event_leak (basic)
[380.605505] Starting subtest: basic
[380.606428] Starting dynamic subtest: pipe-A-HDMI-A-1
[380.811547] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.205s)
[380.826086] Starting dynamic subtest: pipe-B-HDMI-A-1
[381.086624] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.273s)
[381.087451] Subtest basic: SUCCESS (0.483s)
[381.604708] [119/131] (687s left) gem_pwrite_snooped
[381.843588] [120/131] (687s left) gem_render_copy (yf-tiled-ccs-to-y-tiled)
[381.903893] Starting subtest: yf-tiled-ccs-to-y-tiled
[381.904640] Starting dynamic subtest: smem
[381.906129] Dynamic subtest smem: SKIP (0.000s)
[381.908227] Subtest yf-tiled-ccs-to-y-tiled: SKIP (0.002s)
[382.138115] [121/131] (687s left) gem_ctx_shared (q-independent)
[382.197723] Subtest Q-independent: SKIP (0.000s)
[382.319676] [122/131] (687s left) prime_mmap (test_userptr)
[382.375768] Starting subtest: test_userptr
[382.376626] Starting dynamic subtest: test_userptr-smem
[382.377437] Dynamic subtest test_userptr-smem: SUCCESS (0.000s)
[382.378183] Subtest test_userptr: SUCCESS (0.003s)
[382.549049] [123/131] (687s left) kms_addfb_basic (bad-pitch-65536)
[382.605236] Starting subtest: bad-pitch-65536
[382.606022] Subtest bad-pitch-65536: SUCCESS (0.000s)
[383.251316] [124/131] (686s left) prime_self_import (basic-with_fd_dup)
[383.308275] Starting subtest: basic-with_fd_dup
[383.311257] Subtest basic-with_fd_dup: SUCCESS (0.004s)
[383.446847] [125/131] (686s left) kms_rotation_crc (primary-y-tiled-reflect-x-0)
[383.738474] Starting subtest: primary-y-tiled-reflect-x-0
[383.740106] Subtest primary-y-tiled-reflect-x-0: SKIP (0.001s)
[384.151220] [126/131] (685s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[384.216027] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.000s)
[384.277390] [127/131] (685s left) kms_addfb_basic (unused-modifier)
[384.333617] Starting subtest: unused-modifier
[384.334234] Subtest unused-modifier: SUCCESS (0.000s)
[384.979499] [128/131] (685s left) kms_vblank (wait-idle)
[385.273592] Starting subtest: wait-idle
[385.274711] Starting dynamic subtest: pipe-A-HDMI-A-1
[387.490338] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.216s)
[387.509048] Starting dynamic subtest: pipe-B-HDMI-A-1
[389.721550] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.229s)
[389.722308] Subtest wait-idle: SUCCESS (4.450s)
[390.241254] [129/131] (679s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[390.534723] Starting subtest: cursorA-vs-flipA-toggle
[401.430445] Subtest cursorA-vs-flipA-toggle: SUCCESS (10.896s)
[401.953512] [130/131] (668s left) gen9_exec_parse (bb-start-far)
[402.018873] Subtest bb-start-far: SKIP (0.000s)
[402.079144] [131/131] (668s left) kms_addfb_basic (basic)
[402.132846] Starting subtest: basic
[402.133609] Subtest basic: SUCCESS (0.000s)
[402.782134] Closing watchdogs
results: parsing output: 0/ for test: syncobj_eventfd
results: parsing output: 1/ for test: tools_test
results: parsing output: 2/ for test: kms_psr2_su
results: parsing output: 3/ for test: gem_userptr_blits
results: parsing output: 4/ for test: kms_pipe_stress
results: parsing output: 5/ for test: kms_ccs
results: parsing output: 6/ for test: api_intel_allocator
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_atomic_interruptible
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: gem_eio
results: parsing output: 11/ for test: gem_exec_balancer
results: parsing output: 12/ for test: kms_chamelium_hpd
results: parsing output: 13/ for test: kms_flip
results: parsing output: 14/ for test: gem_exec_reloc
results: parsing output: 15/ for test: gem_exec_schedule
results: parsing output: 16/ for test: kms_ccs
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: perf
results: parsing output: 19/ for test: gem_userptr_blits
results: parsing output: 20/ for test: kms_big_fb
results: parsing output: 21/ for test: gem_mmap_offset
results: parsing output: 22/ for test: kms_ccs
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: core_getstats
results: parsing output: 25/ for test: core_getclient
results: parsing output: 26/ for test: syncobj_timeline
results: parsing output: 27/ for test: gem_exec_reloc
results: parsing output: 28/ for test: kms_invalid_mode
results: parsing output: 29/ for test: gem_mmap_offset
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: gem_exec_suspend
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: kms_chamelium_frames
results: parsing output: 36/ for test: gem_exec_fence
results: parsing output: 37/ for test: kms_legacy_colorkey
results: parsing output: 38/ for test: gem_softpin
results: parsing output: 39/ for test: perf_pmu
results: parsing output: 40/ for test: syncobj_timeline
results: parsing output: 41/ for test: gem_tiled_wb
results: parsing output: 42/ for test: kms_ccs
results: parsing output: 43/ for test: gem_ctx_param
results: parsing output: 44/ for test: kms_color_pipeline
results: parsing output: 45/ for test: kms_cursor_legacy
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_feature_discovery
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: i915_drm_fdinfo
results: parsing output: 50/ for test: kms_big_fb
results: parsing output: 51/ for test: gem_exec_schedule
results: parsing output: 52/ for test: gem_pxp
results: parsing output: 53/ for test: gem_exec_balancer
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: fbdev
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_rotation_crc
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: i915_selftest
results: parsing output: 60/ for test: kms_psr2_sf
results: parsing output: 61/ for test: gem_render_copy_redux
results: parsing output: 62/ for test: gem_exec_reloc
results: parsing output: 63/ for test: gem_ctx_param
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: i915_pm_rps
results: parsing output: 66/ for test: kms_async_flips
results: parsing output: 67/ for test: perf_pmu
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: syncobj_timeline
results: parsing output: 70/ for test: kms_cursor_crc
results: parsing output: 71/ for test: kms_psr
results: parsing output: 72/ for test: kms_psr
results: parsing output: 73/ for test: kms_pm_rpm
results: parsing output: 74/ for test: gem_userptr_blits
results: parsing output: 75/ for test: kms_content_protection
results: parsing output: 76/ for test: kms_atomic
results: parsing output: 77/ for test: kms_cursor_legacy
results: parsing output: 78/ for test: kms_plane_scaling
results: parsing output: 79/ for test: kms_psr
results: parsing output: 80/ for test: gem_ctx_persistence
results: parsing output: 81/ for test: kms_cursor_crc
results: parsing output: 82/ for test: kms_cursor_legacy
results: parsing output: 83/ for test: kms_cursor_crc
results: parsing output: 84/ for test: kms_psr
results: parsing output: 85/ for test: kms_big_fb
results: parsing output: 86/ for test: gem_create
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_pm_rpm
results: parsing output: 89/ for test: gem_lmem_swapping
results: parsing output: 90/ for test: kms_cursor_legacy
results: parsing output: 91/ for test: gem_lmem_swapping
results: parsing output: 92/ for test: i915_pm_freq_api
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_dirtyfb
results: parsing output: 96/ for test: kms_plane_scaling
results: parsing output: 97/ for test: kms_flip_scaled_crc
results: parsing output: 98/ for test: kms_cursor_legacy
results: parsing output: 99/ for test: gem_readwrite
results: parsing output: 100/ for test: gem_reg_read
results: parsing output: 101/ for test: kms_psr
results: parsing output: 102/ for test: kms_plane_lowres
results: parsing output: 103/ for test: kms_force_connector_basic
results: parsing output: 104/ for test: kms_getfb
results: parsing output: 105/ for test: perf
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_big_fb
results: parsing output: 110/ for test: gem_exec_fence
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: syncobj_timeline
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: gem_exec_schedule
results: parsing output: 115/ for test: kms_vblank
results: parsing output: 116/ for test: syncobj_wait
results: parsing output: 117/ for test: kms_flip_event_leak
results: parsing output: 118/ for test: gem_pwrite_snooped
results: parsing output: 119/ for test: gem_render_copy
results: parsing output: 120/ for test: gem_ctx_shared
results: parsing output: 121/ for test: prime_mmap
results: parsing output: 122/ for test: kms_addfb_basic
results: parsing output: 123/ for test: prime_self_import
results: parsing output: 124/ for test: kms_rotation_crc
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: kms_addfb_basic
results: parsing output: 127/ for test: kms_vblank
results: parsing output: 128/ for test: kms_cursor_legacy
results: parsing output: 129/ for test: gen9_exec_parse
results: parsing output: 130/ for test: kms_addfb_basic
Done.