[101.900903] Initializing watchdogs
[101.901795]   /dev/watchdog0
[102.032752] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:a001 Intel Pineview (Gen3) Atom Processor D4xx/D5xx/N4xx/N5xx Integrated Graphics Controller (DeskTop Board D510MO)
[102.068422] [001/161] (960s left) i915_module_load (load)
[102.594611] Starting subtest: load
[110.280424] Subtest load: SUCCESS (7.678s)
[110.657533] [FACT i915_module_load (load)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[110.670408] [FACT i915_module_load (load)] new: kernel.kmod_is_loaded.i915: true
[110.701870] [002/161] (952s left) core_auth (basic-auth)
[111.285420] Starting subtest: basic-auth
[111.289754] Subtest basic-auth: SUCCESS (0.004s)
[111.599396] [003/161] (951s left) debugfs_test (read_all_entries)
[112.093813] Starting subtest: read_all_entries
[112.332291] Subtest read_all_entries: SUCCESS (0.242s)
[112.689408] [004/161] (950s left) debugfs_test (basic-hwmon)
[113.161396] Starting subtest: basic-hwmon
[113.172387] Subtest basic-hwmon: SKIP (0.001s)
[113.521351] [005/161] (950s left) debugfs_test (sysfs)
[113.999463] Starting subtest: sysfs
[114.142121] Subtest sysfs: SUCCESS (0.141s)
[114.506567] [006/161] (949s left) fbdev (eof)
[114.997099] Starting subtest: eof
[115.001892] Subtest eof: SUCCESS (0.003s)
[115.293097] [007/161] (949s left) fbdev (info)
[115.737400] Starting subtest: info
[115.741218] Subtest info: SUCCESS (0.000s)
[116.042539] [008/161] (948s left) fbdev (nullptr)
[116.509341] Starting subtest: nullptr
[116.514244] Subtest nullptr: SUCCESS (0.000s)
[116.814446] [009/161] (948s left) fbdev (read)
[117.271827] Starting subtest: read
[117.578398] Subtest read: SUCCESS (0.306s)
[117.880670] [010/161] (947s left) fbdev (write)
[118.323153] Starting subtest: write
[118.508738] Subtest write: SUCCESS (0.185s)
[118.812944] [011/161] (946s left) gem_basic (bad-close)
[119.278499] Starting subtest: bad-close
[119.286682] Subtest bad-close: SUCCESS (0.000s)
[119.581643] [012/161] (946s left) gem_basic (create-close)
[120.043115] Starting subtest: create-close
[120.050498] Subtest create-close: SUCCESS (0.001s)
[120.351955] [013/161] (945s left) gem_basic (create-fd-close)
[120.853106] Starting subtest: create-fd-close
[120.863384] Subtest create-fd-close: SUCCESS (0.002s)
[121.219280] [014/161] (945s left) gem_busy (busy@all-engines)
[121.764527] Starting subtest: busy
[121.769326] Starting dynamic subtest: all-engines
[121.904206] Dynamic subtest all-engines: SUCCESS (0.146s)
[121.908426] Subtest busy: SUCCESS (0.150s)
[122.615499] [015/161] (944s left) gem_close_race (basic-process)
[123.156954] Starting subtest: basic-process
[123.373662] Subtest basic-process: SUCCESS (0.218s)
[123.841272] [016/161] (943s left) gem_close_race (basic-threads)
[124.379683] Starting subtest: basic-threads
[125.940876] Subtest basic-threads: SUCCESS (1.561s)
[126.408645] [017/161] (940s left) gem_ctx_create (basic)
[126.875951] Subtest basic: SKIP (0.000s)
[127.167786] [018/161] (940s left) gem_ctx_create (basic-files)
[127.643111] Subtest basic-files: SKIP (0.000s)
[127.927227] [019/161] (939s left) gem_ctx_exec (basic)
[128.394166] Subtest basic: SKIP (0.000s)
[128.712251] [020/161] (939s left) gem_exec_basic (basic)
[129.241593] Starting subtest: basic
[129.246586] Starting dynamic subtest: rcs0-smem
[129.250352] Dynamic subtest rcs0-smem: SUCCESS (0.002s)
[129.253713] Subtest basic: SUCCESS (0.010s)
[129.716940] [021/161] (938s left) gem_exec_create (basic)
[130.252362] Starting subtest: basic
[130.258104] Starting dynamic subtest: smem
[132.413566] Dynamic subtest smem: SUCCESS (2.160s)
[132.418168] Subtest basic: SUCCESS (2.165s)
[132.882212] [022/161] (935s left) gem_exec_fence (basic-busy)
[133.646672] Starting subtest: basic-busy
[133.652338] Starting dynamic subtest: rcs0
[133.689131] Dynamic subtest rcs0: SUCCESS (0.045s)
[133.694558] Subtest basic-busy: SUCCESS (0.049s)
[134.884687] [FACT gem_exec_fence (basic-busy)] new: kernel.kmod_is_loaded.vgem: true
[134.896885] [023/161] (934s left) gem_exec_fence (basic-wait)
[135.654178] Starting subtest: basic-wait
[135.658976] Starting dynamic subtest: rcs0
[135.687399] Dynamic subtest rcs0: SUCCESS (0.034s)
[135.691079] Subtest basic-wait: SUCCESS (0.038s)
[136.706416] [024/161] (932s left) gem_exec_fence (basic-await)
[137.492941] Starting subtest: basic-await
[137.498077] Starting dynamic subtest: rcs0
[137.636751] Dynamic subtest rcs0: SUCCESS (0.148s)
[137.641649] Subtest basic-await: SUCCESS (0.155s)
[138.636378] [025/161] (930s left) gem_exec_fence (nb-await)
[139.399386] Starting subtest: nb-await
[139.402930] Starting dynamic subtest: rcs0
[139.464696] Dynamic subtest rcs0: SUCCESS (0.067s)
[139.469465] Subtest nb-await: SUCCESS (0.071s)
[140.437696] [026/161] (929s left) gem_exec_gttfill (basic)
[140.980681] Starting subtest: basic
[149.756446] Subtest basic: SUCCESS (8.778s)
[150.305776] [027/161] (919s left) gem_exec_parallel (engines)
[151.145687] Starting subtest: engines
[151.149832] Starting dynamic subtest: basic
[155.354955] Dynamic subtest basic: SUCCESS (4.209s)
[155.409272] Starting dynamic subtest: contexts
[155.417936] Dynamic subtest contexts: SKIP (0.004s)
[155.468359] Starting dynamic subtest: fds
[155.475711] Dynamic subtest fds: SKIP (0.004s)
[155.520118] Starting dynamic subtest: userptr
[159.654106] Dynamic subtest userptr: SUCCESS (4.279s)
[159.657774] Subtest engines: SUCCESS (8.511s)
[160.156817] [028/161] (910s left) gem_exec_store (basic)
[160.688794] Starting subtest: basic
[160.741290] Subtest basic: SUCCESS (0.058s)
[161.238807] [029/161] (909s left) gem_flink_basic (bad-flink)
[161.704551] Starting subtest: bad-flink
[161.708761] Subtest bad-flink: SUCCESS (0.000s)
[162.053943] [030/161] (909s left) gem_flink_basic (bad-open)
[162.509311] Starting subtest: bad-open
[162.514322] Subtest bad-open: SUCCESS (0.000s)
[162.850733] [031/161] (908s left) gem_flink_basic (basic)
[163.302144] Starting subtest: basic
[163.306719] Subtest basic: SUCCESS (0.001s)
[163.665468] [032/161] (908s left) gem_flink_basic (double-flink)
[164.124783] Starting subtest: double-flink
[164.130496] Subtest double-flink: SUCCESS (0.001s)
[164.490623] [033/161] (907s left) gem_flink_basic (flink-lifetime)
[164.947564] Starting subtest: flink-lifetime
[164.962099] Subtest flink-lifetime: SUCCESS (0.009s)
[165.302225] [034/161] (907s left) gem_huc_copy (huc-copy)
[165.802838] Subtest huc-copy: SKIP (0.000s)
[166.205681] [035/161] (906s left) gem_linear_blits (basic)
[167.005256] Starting subtest: basic
[167.049396] Subtest basic: SUCCESS (0.051s)
[167.503997] [036/161] (905s left) gem_mmap (basic)
[168.184548] Starting subtest: basic
[168.203526] Subtest basic: SUCCESS (0.003s)
[168.547696] [037/161] (905s left) gem_mmap_gtt (basic)
[169.001619] Starting subtest: basic
[169.006424] Subtest basic: SUCCESS (0.005s)
[169.364833] [038/161] (904s left) gem_render_linear_blits (basic)
[169.842801] Starting subtest: basic
[169.994160] Subtest basic: SUCCESS (0.154s)
[170.354794] [039/161] (903s left) gem_render_tiled_blits (basic)
[170.831504] Starting subtest: basic
[171.014663] Subtest basic: SUCCESS (0.183s)
[171.362109] [040/161] (903s left) gem_ringfill (basic-all)
[171.941174] Starting subtest: basic-all
[173.166449] Subtest basic-all: SUCCESS (1.227s)
[173.531314] [041/161] (901s left) gem_softpin (allocator-basic)
[173.998791] Subtest allocator-basic: SKIP (0.000s)
[174.349563] [042/161] (900s left) gem_softpin (allocator-basic-reserve)
[174.828671] Subtest allocator-basic-reserve: SKIP (0.000s)
[175.177810] [043/161] (900s left) gem_softpin (safe-alignment)
[175.649080] Starting subtest: safe-alignment
[175.659711] Subtest safe-alignment: SUCCESS (0.018s)
[176.039162] [044/161] (899s left) gem_sync (basic-all)
[176.588801] Starting subtest: basic-all
[178.814632] Subtest basic-all: SUCCESS (2.230s)
[179.319679] [045/161] (896s left) gem_sync (basic-each)
[179.889945] Starting subtest: basic-each
[182.199333] Subtest basic-each: SUCCESS (2.313s)
[182.703312] [046/161] (893s left) gem_tiled_blits (basic)
[183.548221] Starting subtest: basic
[183.649131] Subtest basic: SUCCESS (0.108s)
[184.101164] [047/161] (892s left) gem_tiled_fence_blits (basic)
[185.206065] Starting subtest: basic
[185.272271] Subtest basic: SUCCESS (0.071s)
[185.713714] [048/161] (891s left) gem_tiled_pread_basic
[188.744899] [049/161] (888s left) gem_wait (busy@all-engines)
[189.350557] Starting subtest: busy
[189.355473] Starting dynamic subtest: all-engines
[189.890869] Dynamic subtest all-engines: SUCCESS (0.536s)
[189.895366] Subtest busy: SUCCESS (0.540s)
[190.540593] [050/161] (887s left) gem_wait (wait@all-engines)
[191.126284] Starting subtest: wait
[191.132329] Starting dynamic subtest: all-engines
[192.186699] Dynamic subtest all-engines: SUCCESS (1.060s)
[192.191462] Subtest wait: SUCCESS (1.064s)
[192.839550] [051/161] (885s left) i915_getparams_basic (basic-eu-total)
[193.292645] Starting subtest: basic-eu-total
[193.301707] Subtest basic-eu-total: SUCCESS (0.000s)
[193.639963] [052/161] (884s left) i915_getparams_basic (basic-subslice-total)
[194.093713] Starting subtest: basic-subslice-total
[194.100619] Subtest basic-subslice-total: SUCCESS (0.001s)
[194.453395] [053/161] (884s left) i915_hangman (error-state-basic)
[194.937237] Starting subtest: error-state-basic
[195.355296] Subtest error-state-basic: SUCCESS (0.412s)
[195.759816] [054/161] (883s left) i915_pciid
[196.649134] [055/161] (882s left) kms_addfb_basic (addfb25-4-tiled)
[197.190907] Starting subtest: addfb25-4-tiled
[197.195932] Subtest addfb25-4-tiled: SUCCESS (0.002s)
[197.553274] [056/161] (882s left) kms_addfb_basic (addfb25-bad-modifier)
[198.075379] Starting subtest: addfb25-bad-modifier
[198.079327] Subtest addfb25-bad-modifier: SUCCESS (0.002s)
[198.441884] [057/161] (881s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[198.955644] Starting subtest: addfb25-framebuffer-vs-set-tiling
[198.960294] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.001s)
[199.336497] [058/161] (881s left) kms_addfb_basic (addfb25-modifier-no-flag)
[199.855739] Starting subtest: addfb25-modifier-no-flag
[199.860915] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[200.222214] [059/161] (880s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[200.739974] Starting subtest: addfb25-x-tiled-legacy
[200.745765] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s)
[201.105410] [060/161] (879s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[201.625569] Starting subtest: addfb25-x-tiled-mismatch-legacy
[201.630666] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.002s)
[201.991634] [061/161] (879s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[202.509611] Starting subtest: addfb25-yf-tiled-legacy
[202.514294] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.002s)
[202.872673] [062/161] (878s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[203.395798] Starting subtest: addfb25-y-tiled-legacy
[203.400679] Subtest addfb25-y-tiled-legacy: SUCCESS (0.002s)
[203.777931] [063/161] (878s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[204.296688] Starting subtest: addfb25-y-tiled-small-legacy
[204.305342] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[204.666251] [064/161] (877s left) kms_addfb_basic (bad-pitch-0)
[205.129609] Starting subtest: bad-pitch-0
[205.133928] Subtest bad-pitch-0: SUCCESS (0.000s)
[205.549679] [065/161] (877s left) kms_addfb_basic (bad-pitch-1024)
[206.015508] Starting subtest: bad-pitch-1024
[206.020393] Subtest bad-pitch-1024: SUCCESS (0.000s)
[206.427209] [066/161] (876s left) kms_addfb_basic (bad-pitch-128)
[206.888425] Starting subtest: bad-pitch-128
[206.893394] Subtest bad-pitch-128: SUCCESS (0.000s)
[207.309967] [067/161] (876s left) kms_addfb_basic (bad-pitch-256)
[207.780277] Starting subtest: bad-pitch-256
[207.784936] Subtest bad-pitch-256: SUCCESS (0.000s)
[208.205609] [068/161] (875s left) kms_addfb_basic (bad-pitch-32)
[208.668553] Starting subtest: bad-pitch-32
[208.672858] Subtest bad-pitch-32: SUCCESS (0.000s)
[209.096772] [069/161] (874s left) kms_addfb_basic (bad-pitch-63)
[209.563913] Starting subtest: bad-pitch-63
[209.570840] Subtest bad-pitch-63: SUCCESS (0.000s)
[209.994295] [070/161] (874s left) kms_addfb_basic (bad-pitch-65536)
[210.455738] Starting subtest: bad-pitch-65536
[210.461169] Subtest bad-pitch-65536: SUCCESS (0.002s)
[211.017406] [071/161] (873s left) kms_addfb_basic (bad-pitch-999)
[211.476430] Starting subtest: bad-pitch-999
[211.481613] Subtest bad-pitch-999: SUCCESS (0.000s)
[211.914124] [072/161] (873s left) kms_addfb_basic (basic)
[212.375558] Starting subtest: basic
[212.379772] Subtest basic: SUCCESS (0.001s)
[212.809304] [073/161] (872s left) kms_addfb_basic (basic-x-tiled-legacy)
[213.278375] Starting subtest: basic-x-tiled-legacy
[213.282197] Subtest basic-x-tiled-legacy: SUCCESS (0.001s)
[213.696891] [074/161] (872s left) kms_addfb_basic (basic-y-tiled-legacy)
[214.162260] Starting subtest: basic-y-tiled-legacy
[214.166919] Subtest basic-y-tiled-legacy: SUCCESS (0.002s)
[214.606293] [075/161] (871s left) kms_addfb_basic (bo-too-small)
[215.117511] Starting subtest: bo-too-small
[215.123489] Subtest bo-too-small: SUCCESS (0.002s)
[215.492736] [076/161] (870s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[216.011870] Starting subtest: bo-too-small-due-to-tiling
[216.017777] Subtest bo-too-small-due-to-tiling: SUCCESS (0.002s)
[216.394273] [077/161] (870s left) kms_addfb_basic (clobberred-modifier)
[216.858420] Starting subtest: clobberred-modifier
[216.863115] Subtest clobberred-modifier: SUCCESS (0.001s)
[217.296227] [078/161] (869s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[217.758370] Starting subtest: framebuffer-vs-set-tiling
[217.763589] Subtest framebuffer-vs-set-tiling: SUCCESS (0.001s)
[218.173219] [079/161] (869s left) kms_addfb_basic (invalid-get-prop)
[218.628720] Starting subtest: invalid-get-prop
[218.633734] Subtest invalid-get-prop: SUCCESS (0.000s)
[219.071173] [080/161] (868s left) kms_addfb_basic (invalid-get-prop-any)
[219.521879] Starting subtest: invalid-get-prop-any
[219.526981] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[219.947510] [081/161] (868s left) kms_addfb_basic (invalid-set-prop)
[220.397498] Starting subtest: invalid-set-prop
[220.401820] Subtest invalid-set-prop: SUCCESS (0.000s)
[220.825374] [082/161] (867s left) kms_addfb_basic (invalid-set-prop-any)
[221.295332] Starting subtest: invalid-set-prop-any
[221.299996] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[221.715299] [083/161] (866s left) kms_addfb_basic (no-handle)
[222.170826] Starting subtest: no-handle
[222.174741] Subtest no-handle: SUCCESS (0.000s)
[222.615265] [084/161] (866s left) kms_addfb_basic (size-max)
[223.138134] Starting subtest: size-max
[223.142956] Subtest size-max: SUCCESS (0.001s)
[223.537344] [085/161] (865s left) kms_addfb_basic (small-bo)
[224.054632] Starting subtest: small-bo
[224.059749] Subtest small-bo: SUCCESS (0.000s)
[224.440236] [086/161] (865s left) kms_addfb_basic (tile-pitch-mismatch)
[224.909917] Starting subtest: tile-pitch-mismatch
[224.914339] Subtest tile-pitch-mismatch: SUCCESS (0.002s)
[225.340488] [087/161] (864s left) kms_addfb_basic (too-high)
[225.907344] Starting subtest: too-high
[225.915383] Subtest too-high: SUCCESS (0.007s)
[226.315495] [088/161] (864s left) kms_addfb_basic (too-wide)
[226.820109] Starting subtest: too-wide
[226.824812] Subtest too-wide: SUCCESS (0.000s)
[227.184544] [089/161] (863s left) kms_addfb_basic (unused-handle)
[227.649581] Starting subtest: unused-handle
[227.653612] Subtest unused-handle: SUCCESS (0.000s)
[228.079587] [090/161] (862s left) kms_addfb_basic (unused-modifier)
[228.542462] Starting subtest: unused-modifier
[228.546705] Subtest unused-modifier: SUCCESS (0.000s)
[228.958337] [091/161] (862s left) kms_addfb_basic (unused-offsets)
[229.421495] Starting subtest: unused-offsets
[229.426430] Subtest unused-offsets: SUCCESS (0.000s)
[229.858273] [092/161] (861s left) kms_addfb_basic (unused-pitches)
[230.317817] Starting subtest: unused-pitches
[230.323155] Subtest unused-pitches: SUCCESS (0.000s)
[230.741991] [093/161] (861s left) kms_busy (basic)
[231.255647] Starting subtest: basic
[231.261094] Starting dynamic subtest: flip
[232.280326] Dynamic subtest flip: SUCCESS (1.015s)
[232.334297] Starting dynamic subtest: modeset
[232.343094] Dynamic subtest modeset: SKIP (0.001s)
[232.347185] Subtest basic: SUCCESS (1.026s)
[232.809336] [094/161] (859s left) kms_prop_blob (basic)
[233.268481] Starting subtest: basic
[233.272625] Subtest basic: SUCCESS (0.000s)
[233.614224] [095/161] (859s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[234.125414] Starting subtest: basic-busy-flip-before-cursor-atomic
[234.145372] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.019s)
[234.518551] [096/161] (858s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[235.022761] Starting subtest: basic-busy-flip-before-cursor-legacy
[236.131368] Subtest basic-busy-flip-before-cursor-legacy: SUCCESS (1.111s)
[236.644258] [097/161] (856s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[237.148801] Starting subtest: basic-flip-after-cursor-atomic
[237.155942] Subtest basic-flip-after-cursor-atomic: SKIP (0.000s)
[237.510409] [098/161] (856s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[238.010465] Starting subtest: basic-flip-after-cursor-legacy
[239.097108] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.089s)
[239.627681] [099/161] (854s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[240.115334] Starting subtest: basic-flip-after-cursor-varying-size
[241.205345] Subtest basic-flip-after-cursor-varying-size: SUCCESS (1.089s)
[241.709291] [100/161] (852s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[242.226298] Starting subtest: basic-flip-before-cursor-atomic
[242.235682] Subtest basic-flip-before-cursor-atomic: SKIP (0.000s)
[242.596672] [101/161] (851s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[243.096863] Starting subtest: basic-flip-before-cursor-legacy
[244.194843] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.101s)
[244.715582] [102/161] (850s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[245.228392] Starting subtest: basic-flip-before-cursor-varying-size
[246.329717] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.102s)
[246.859458] [103/161] (848s left) kms_dsc (dsc-basic)
[247.353371] Subtest dsc-basic: SKIP (0.000s)
[247.691887] [104/161] (847s left) kms_flip (basic-flip-vs-dpms)
[248.203510] Starting subtest: basic-flip-vs-dpms
[248.207211] Starting dynamic subtest: A-VGA1
[249.889082] Dynamic subtest A-VGA1: SUCCESS (1.680s)
[249.943512] Starting dynamic subtest: B-VGA1
[251.420145] Dynamic subtest B-VGA1: SUCCESS (1.522s)
[251.425953] Subtest basic-flip-vs-dpms: SUCCESS (3.213s)
[252.127298] [105/161] (843s left) kms_flip (basic-flip-vs-modeset)
[252.650605] Starting subtest: basic-flip-vs-modeset
[252.655274] Starting dynamic subtest: A-VGA1
[254.338476] Dynamic subtest A-VGA1: SUCCESS (1.677s)
[254.394106] Starting dynamic subtest: B-VGA1
[255.850545] Dynamic subtest B-VGA1: SUCCESS (1.488s)
[255.860501] Subtest basic-flip-vs-modeset: SUCCESS (3.178s)
[256.576073] [106/161] (839s left) kms_flip (basic-flip-vs-wf_vblank)
[257.091796] Starting subtest: basic-flip-vs-wf_vblank
[257.097447] Starting dynamic subtest: A-VGA1
[258.929787] Dynamic subtest A-VGA1: SUCCESS (1.827s)
[258.984610] Starting dynamic subtest: B-VGA1
[260.654430] Dynamic subtest B-VGA1: SUCCESS (1.720s)
[260.659912] Subtest basic-flip-vs-wf_vblank: SUCCESS (3.559s)
[261.357531] [107/161] (835s left) kms_flip (basic-plain-flip)
[261.872458] Starting subtest: basic-plain-flip
[261.877494] Starting dynamic subtest: A-VGA1
[263.414321] Dynamic subtest A-VGA1: SUCCESS (1.536s)
[263.468606] Starting dynamic subtest: B-VGA1
[264.865143] Dynamic subtest B-VGA1: SUCCESS (1.446s)
[264.869709] Subtest basic-plain-flip: SUCCESS (2.992s)
[265.554763] [108/161] (831s left) kms_force_connector_basic (force-connector-state)
[266.105633] Starting subtest: force-connector-state
[266.391836] Subtest force-connector-state: SUCCESS (0.282s)
[267.079588] [109/161] (830s left) kms_force_connector_basic (force-edid)
[267.639418] Starting subtest: force-edid
[267.762111] Subtest force-edid: SUCCESS (0.113s)
[268.215965] [110/161] (829s left) kms_force_connector_basic (force-load-detect)
[268.772384] Starting subtest: force-load-detect
[269.287665] Subtest force-load-detect: SUCCESS (0.512s)
[269.888774] [111/161] (827s left) kms_force_connector_basic (prune-stale-modes)
[270.448169] Starting subtest: prune-stale-modes
[270.581226] Subtest prune-stale-modes: SUCCESS (0.132s)
[271.158568] [112/161] (827s left) kms_frontbuffer_tracking (basic)
[271.690672] Subtest basic: SKIP (0.000s)
[272.021114] [113/161] (826s left) kms_hdmi_inject (inject-audio)
[272.487667] Subtest inject-audio: SKIP (0.000s)
[272.826904] [114/161] (826s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[273.337886] Starting subtest: compare-crc-sanitycheck-xr24
[273.342807] Starting dynamic subtest: pipe-A-VGA-1
[273.752418] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.404s)
[273.800576] Starting dynamic subtest: pipe-B-VGA-1
[274.276880] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.516s)
[274.282462] Subtest compare-crc-sanitycheck-xr24: SUCCESS (0.940s)
[274.788399] [115/161] (824s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[275.296375] Starting subtest: compare-crc-sanitycheck-nv12
[275.302548] Starting dynamic subtest: pipe-A-VGA-1
[275.311844] Dynamic subtest pipe-A-VGA-1: SKIP (0.001s)
[275.362213] Starting dynamic subtest: pipe-B-VGA-1
[275.370963] Dynamic subtest pipe-B-VGA-1: SKIP (0.002s)
[275.379225] Subtest compare-crc-sanitycheck-nv12: SKIP (0.017s)
[275.694933] [116/161] (823s left) kms_pipe_crc_basic (hang-read-crc)
[276.196978] Starting subtest: hang-read-crc
[276.200915] Starting dynamic subtest: pipe-A-VGA-1
[277.528735] Dynamic subtest pipe-A-VGA-1: SUCCESS (1.327s)
[277.603169] Starting dynamic subtest: pipe-B-VGA-1
[278.969661] Dynamic subtest pipe-B-VGA-1: SUCCESS (1.433s)
[278.974894] Subtest hang-read-crc: SUCCESS (2.776s)
[279.481571] [117/161] (820s left) kms_pipe_crc_basic (nonblocking-crc)
[279.991602] Starting subtest: nonblocking-crc
[280.001347] Starting dynamic subtest: pipe-A-VGA-1
[280.590882] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.588s)
[280.659739] Starting dynamic subtest: pipe-B-VGA-1
[281.319408] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.718s)
[281.323977] Subtest nonblocking-crc: SUCCESS (1.325s)
[281.841684] [118/161] (818s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[282.342340] Starting subtest: nonblocking-crc-frame-sequence
[282.352529] Starting dynamic subtest: pipe-A-VGA-1
[282.958289] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.607s)
[283.007701] Starting dynamic subtest: pipe-B-VGA-1
[283.725135] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.757s)
[283.729138] Subtest nonblocking-crc-frame-sequence: SUCCESS (1.383s)
[284.252341] [119/161] (816s left) kms_pipe_crc_basic (read-crc)
[284.747688] Starting subtest: read-crc
[284.762143] Starting dynamic subtest: pipe-A-VGA-1
[285.297884] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.540s)
[285.348076] Starting dynamic subtest: pipe-B-VGA-1
[285.988165] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.677s)
[285.992796] Subtest read-crc: SUCCESS (1.237s)
[286.508370] [120/161] (814s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[287.021557] Starting subtest: read-crc-frame-sequence
[287.026419] Starting dynamic subtest: pipe-A-VGA-1
[287.560762] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.532s)
[287.624924] Starting dynamic subtest: pipe-B-VGA-1
[288.212581] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.643s)
[288.218175] Subtest read-crc-frame-sequence: SUCCESS (1.194s)
[288.726929] [121/161] (812s left) kms_pm_backlight (basic-brightness)
[289.243136] Subtest basic-brightness: SKIP (0.000s)
[289.589259] [122/161] (812s left) kms_pm_rpm (basic-pci-d3-state)
[301.514406] Subtest basic-pci-d3-state: SKIP (0.000s)
[301.839904] [123/161] (800s left) kms_pm_rpm (basic-rte)
[302.287887] Starting subtest: basic-rte
[313.732266] Subtest basic-rte: SKIP (11.439s)
[314.060397] [124/161] (788s left) kms_psr (psr-primary-page-flip)
[314.576452] Subtest psr-primary-page-flip: SKIP (0.000s)
[314.900471] [125/161] (787s left) kms_psr (psr-cursor-plane-move)
[315.413909] Subtest psr-cursor-plane-move: SKIP (0.000s)
[315.757595] [126/161] (787s left) kms_psr (psr-sprite-plane-onoff)
[316.326827] Subtest psr-sprite-plane-onoff: SKIP (0.000s)
[316.662282] [127/161] (786s left) kms_psr (psr-primary-mmap-gtt)
[317.159480] Subtest psr-primary-mmap-gtt: SKIP (0.000s)
[317.495313] [128/161] (786s left) kms_setmode (basic-clone-single-crtc)
[317.969421] Starting subtest: basic-clone-single-crtc
[317.980735] Subtest basic-clone-single-crtc: SKIP (0.001s)
[318.341918] [129/161] (785s left) i915_pm_rps (basic-api)
[318.814257] Subtest basic-api: SKIP (0.000s)
[319.152722] [130/161] (785s left) prime_self_import (basic-llseek-bad)
[319.602513] Starting subtest: basic-llseek-bad
[319.621542] Subtest basic-llseek-bad: SUCCESS (0.016s)
[319.998929] [131/161] (784s left) prime_self_import (basic-llseek-size)
[320.450983] Starting subtest: basic-llseek-size
[320.469561] Subtest basic-llseek-size: SUCCESS (0.026s)
[320.842792] [132/161] (784s left) prime_self_import (basic-with_fd_dup)
[321.272634] Starting subtest: basic-with_fd_dup
[321.299991] Subtest basic-with_fd_dup: SUCCESS (0.026s)
[321.660596] [133/161] (783s left) prime_self_import (basic-with_one_bo)
[322.101272] Starting subtest: basic-with_one_bo
[322.128242] Subtest basic-with_one_bo: SUCCESS (0.027s)
[322.488958] [134/161] (783s left) prime_self_import (basic-with_one_bo_two_files)
[322.936520] Starting subtest: basic-with_one_bo_two_files
[322.953459] Subtest basic-with_one_bo_two_files: SUCCESS (0.017s)
[323.309517] [135/161] (782s left) prime_self_import (basic-with_two_bos)
[323.756684] Starting subtest: basic-with_two_bos
[323.778122] Subtest basic-with_two_bos: SUCCESS (0.023s)
[324.154902] [136/161] (781s left) prime_vgem (basic-fence-flip)
[324.640158] Starting subtest: basic-fence-flip
[325.281419] Subtest basic-fence-flip: SUCCESS (0.642s)
[325.667144] [137/161] (780s left) prime_vgem (basic-fence-mmap)
[326.150930] Starting subtest: basic-fence-mmap
[326.353495] Subtest basic-fence-mmap: SUCCESS (0.204s)
[326.729627] [138/161] (780s left) prime_vgem (basic-fence-read)
[327.227811] Starting subtest: basic-fence-read
[327.492589] Subtest basic-fence-read: SUCCESS (0.267s)
[327.863804] [139/161] (779s left) prime_vgem (basic-gtt)
[328.343531] Starting subtest: basic-gtt
[328.418653] Subtest basic-gtt: SUCCESS (0.079s)
[328.781846] [140/161] (778s left) prime_vgem (basic-read)
[329.253324] Starting subtest: basic-read
[329.360302] Subtest basic-read: SUCCESS (0.106s)
[329.729428] [141/161] (778s left) prime_vgem (basic-write)
[330.214823] Starting subtest: basic-write
[330.327474] Subtest basic-write: SUCCESS (0.119s)
[330.702197] [142/161] (777s left) vgem_basic (setversion)
[331.252513] Starting subtest: setversion
[331.259421] Subtest setversion: SUCCESS (0.000s)
[331.602133] [143/161] (776s left) vgem_basic (create)
[332.064941] Starting subtest: create
[332.070638] Subtest create: SUCCESS (0.003s)
[332.419180] [144/161] (776s left) vgem_basic (debugfs)
[332.871628] Starting subtest: debugfs
[332.876285] Subtest debugfs: SUCCESS (0.004s)
[333.213835] [145/161] (775s left) vgem_basic (dmabuf-export)
[333.693533] Starting subtest: dmabuf-export
[333.704238] Subtest dmabuf-export: SUCCESS (0.013s)
[334.069849] [146/161] (775s left) vgem_basic (dmabuf-fence)
[334.521110] Starting subtest: dmabuf-fence
[334.526554] Subtest dmabuf-fence: SUCCESS (0.005s)
[334.872755] [147/161] (774s left) vgem_basic (dmabuf-fence-before)
[335.339973] Starting subtest: dmabuf-fence-before
[335.344770] Subtest dmabuf-fence-before: SUCCESS (0.004s)
[335.687913] [148/161] (774s left) vgem_basic (dmabuf-mmap)
[336.158580] Starting subtest: dmabuf-mmap
[336.235803] Subtest dmabuf-mmap: SUCCESS (0.087s)
[336.581575] [149/161] (773s left) vgem_basic (mmap)
[337.040168] Starting subtest: mmap
[337.093114] Subtest mmap: SUCCESS (0.061s)
[337.435911] [150/161] (773s left) vgem_basic (second-client)
[337.890094] Starting subtest: second-client
[337.919742] Subtest second-client: SUCCESS (0.032s)
[338.268713] [151/161] (772s left) vgem_basic (sysfs)
[338.736560] Starting subtest: sysfs
[338.748413] Subtest sysfs: SUCCESS (0.009s)
[339.089737] [152/161] (772s left) core_hotunplug (unbind-rebind)
[339.869487] Starting subtest: unbind-rebind
[346.679469] Subtest unbind-rebind: SUCCESS (6.807s)
[347.251328] [153/161] (764s left) vgem_basic (unload)
[347.744473] Starting subtest: unload
[377.575239] Subtest unload: SUCCESS (29.833s)
[378.118907] [154/161] (734s left) i915_module_load (reload)
[378.572419] Starting subtest: reload
[388.628192] Subtest reload: SUCCESS (10.055s)
[389.283435] [155/161] (723s left) gem_lmem_swapping (basic)
[390.098862] Subtest basic: SKIP (0.000s)
[390.449846] [156/161] (722s left) gem_lmem_swapping (parallel-random-engines)
[391.002883] Subtest parallel-random-engines: SKIP (0.000s)
[391.341639] [157/161] (722s left) gem_lmem_swapping (random-engines)
[391.816768] Subtest random-engines: SKIP (0.000s)
[392.151417] [158/161] (721s left) gem_lmem_swapping (verify-random)
[392.625291] Subtest verify-random: SKIP (0.000s)
[392.953828] [159/161] (721s left) i915_pm_rpm (module-reload)
[404.915407] Subtest module-reload: SKIP (0.000s)
[405.251108] [160/161] (709s left) i915_selftest (live)
[408.302937] Starting subtest: live
[408.306490] Starting dynamic subtest: sanitycheck
[415.719986] Dynamic subtest sanitycheck: SUCCESS (7.416s)
[415.799508] Starting dynamic subtest: uncore
[423.146101] Dynamic subtest uncore: SUCCESS (7.421s)
[423.203760] Starting dynamic subtest: workarounds
[430.550425] Dynamic subtest workarounds: SUCCESS (7.399s)
[430.630685] Starting dynamic subtest: gt_engines
[437.974978] Dynamic subtest gt_engines: SUCCESS (7.415s)
[438.032488] Starting dynamic subtest: gt_timelines
[451.855621] Dynamic subtest gt_timelines: SUCCESS (13.879s)
[451.907399] Starting dynamic subtest: gt_contexts
[459.372534] Dynamic subtest gt_contexts: SUCCESS (7.510s)
[459.427390] Starting dynamic subtest: gt_lrc
[466.763567] Dynamic subtest gt_lrc: SUCCESS (7.384s)
[466.848249] Starting dynamic subtest: gt_mocs
[474.193371] Dynamic subtest gt_mocs: SUCCESS (7.425s)
[474.238119] Starting dynamic subtest: gt_pm
[482.031438] Dynamic subtest gt_pm: SUCCESS (7.833s)
[482.081140] Starting dynamic subtest: gt_heartbeat
[489.513582] Dynamic subtest gt_heartbeat: SUCCESS (7.476s)
[489.608198] Starting dynamic subtest: gt_tlb
[496.875698] Dynamic subtest gt_tlb: SUCCESS (7.354s)
[496.934857] Starting dynamic subtest: requests
[507.052201] Dynamic subtest requests: SUCCESS (10.173s)
[507.098958] Starting dynamic subtest: migrate
[514.450257] Dynamic subtest migrate: SUCCESS (7.392s)
[514.515074] Starting dynamic subtest: active
[521.911414] Dynamic subtest active: SUCCESS (7.455s)
[521.970820] Starting dynamic subtest: objects
[530.141372] Dynamic subtest objects: SUCCESS (8.224s)
[530.239222] Starting dynamic subtest: mman
[544.992260] Dynamic subtest mman: SUCCESS (14.844s)
[545.039569] Starting dynamic subtest: dmabuf
[552.585503] Dynamic subtest dmabuf: SUCCESS (7.584s)
[552.633932] Starting dynamic subtest: vma
[560.072181] Dynamic subtest vma: SUCCESS (7.478s)
[560.120580] Starting dynamic subtest: coherency
[573.174708] Dynamic subtest coherency: SUCCESS (13.094s)
[573.235446] Starting dynamic subtest: gtt
[583.599163] Dynamic subtest gtt: SUCCESS (10.417s)
[583.674817] Starting dynamic subtest: gem
[591.409443] Dynamic subtest gem: SUCCESS (7.806s)
[591.458770] Starting dynamic subtest: evict
[598.846190] Dynamic subtest evict: SUCCESS (7.425s)
[598.918264] Starting dynamic subtest: hugepages
[606.263509] Dynamic subtest hugepages: SUCCESS (7.403s)
[606.352887] Starting dynamic subtest: gem_contexts
[613.701435] Dynamic subtest gem_contexts: SUCCESS (7.432s)
[613.749813] Starting dynamic subtest: client
[621.337229] Dynamic subtest client: SUCCESS (7.627s)
[621.381650] Starting dynamic subtest: gem_migrate
[628.807678] Dynamic subtest gem_migrate: SUCCESS (7.465s)
[628.852640] Starting dynamic subtest: reset
[638.276178] Dynamic subtest reset: SUCCESS (9.460s)
[638.330776] Starting dynamic subtest: memory_region
[645.669657] Dynamic subtest memory_region: SUCCESS (7.388s)
[645.732773] Starting dynamic subtest: hangcheck
[654.271394] Dynamic subtest hangcheck: SUCCESS (8.596s)
[654.316685] Starting dynamic subtest: execlists
[661.771664] Dynamic subtest execlists: SUCCESS (7.492s)
[661.832855] Starting dynamic subtest: ring_submission
[669.180200] Dynamic subtest ring_submission: SUCCESS (7.402s)
[669.228324] Starting dynamic subtest: perf
[676.418720] Dynamic subtest perf: SUCCESS (7.228s)
[676.501501] Starting dynamic subtest: slpc
[683.948185] Dynamic subtest slpc: SUCCESS (7.522s)
[684.047206] Starting dynamic subtest: guc
[691.441906] Dynamic subtest guc: SUCCESS (7.486s)
[691.517175] Starting dynamic subtest: guc_multi_lrc
[700.120539] Dynamic subtest guc_multi_lrc: SUCCESS (8.671s)
[700.180139] Starting dynamic subtest: guc_hang
[707.645703] Dynamic subtest guc_hang: SUCCESS (7.518s)
[707.713198] Starting dynamic subtest: late_gt_pm
[715.123266] Dynamic subtest late_gt_pm: SUCCESS (7.468s)
[715.128693] Subtest live: SUCCESS (306.817s)
[715.386941] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[715.397627] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[715.410443] [161/161] (399s left) dmabuf (all-tests)
[715.880507] Starting subtest: all-tests
[715.885852] Starting dynamic subtest: sanitycheck
[716.014249] Dynamic subtest sanitycheck: SUCCESS (0.137s)
[716.075705] Starting dynamic subtest: dma_fence
[716.308447] Dynamic subtest dma_fence: SUCCESS (0.285s)
[716.363782] Starting dynamic subtest: dma_fence_chain