Re: ath9k: BUG kmalloc-8192: Poison overwritten

["Justin P. Mattock" <justinmattock@gmail.com>]

On 05/14/10 09:53, Luis R. Rodriguez wrote:
> On Fri, May 14, 2010 at 08:41:13AM -0700, Justin P. Mattock wrote:
>> On 05/13/10 23:38, Bruno Randolf wrote:
>>> On Friday 14 May 2010 15:31:26 Justin P. Mattock wrote:
>>>> On 05/13/10 23:20, Bruno Randolf wrote:
>>>>> On Friday 14 May 2010 15:16:22 Luis R. Rodriguez wrote:
>>>>>> On Thu, May 13, 2010 at 9:44 PM, Justin P. Mattock
>>>>>>
>>>>>> <justinmattock@gmail.com>    wrote:
>>>>>>> On 05/13/10 21:01, Luis R. Rodriguez wrote:
>>>>>>>> On Thu, May 13, 2010 at 7:14 PM, Justin P. Mattock
>>>>>>>>
>>>>>>>> <justinmattock@gmail.com>     wrote:
>>>>>>>>> what I can try, is(not at the convention, on eth0
>>>>>>>>> at the moment), but when I get back to the convention
>>>>>>>>> center place I can try your patch as well as the
>>>>>>>>> modprobe option, to see if I can get any signs of
>>>>>>>>> a recreation(if so I'll bisect there).
>>>>>>>>
>>>>>>>> The debug info I just need upon load of the module, I don't need you
>>>>>>>> to run the debug stuff to try to reproduce. The debug print upon load
>>>>>>>> will tell us the rxbuf size and cache line size.
>>>>>>>>
>>>>>>>>      Luis
>>>>>>>
>>>>>>> o.k. it's not pretty due
>>>>>>> to loads of avc's for SELinux:
>>>>>>> (I run a rootless system).
>>>>>>>
>>>>>>> [   84.172649] ath9k: Driver unloaded
>>>>>>> [  100.675300] audit_printk_skb: 6 callbacks suppressed
>>>>>>> [  100.675306] type=1400 audit(1273811633.675:20): avc:  denied  {
>>>>>>> search } for  pid=2168 comm="modprobe" name="modules" dev=sda3
>>>>>>> ino=2500 scontext=name:staff_r:staff_sudo_t:s0
>>>>>>> tcontext=system_u:object_r:modules_object_t:s0 tclass=dir
>>>>>>> [  100.675408] type=1400 audit(1273811633.675:20): avc:  denied  {
>>>>>>> search } for  pid=2168 comm="modprobe"
>>>>>>> name="2.6.34-rc7-00057-gcdfda35" dev=sda3 ino=524392
>>>>>>> scontext=name:staff_r:staff_sudo_t:s0
>>>>>>> tcontext=name:object_r:modules_object_t:s0 tclass=dir
>>>>>>> [  100.675552] type=1400 audit(1273811633.675:20): avc:  denied  { read
>>>>>>> } for  pid=2168 comm="modprobe" name="modules.dep.bin" dev=sda3
>>>>>>> ino=525251 scontext=name:staff_r:staff_sudo_t:s0
>>>>>>> tcontext=name:object_r:modules_object_t:s0 tclass=file
>>>>>>> [  100.675598] type=1400 audit(1273811633.675:20): avc:  denied  { open
>>>>>>> } for  pid=2168 comm="modprobe" name="modules.dep.bin" dev=sda3
>>>>>>> ino=525251 scontext=name:staff_r:staff_sudo_t:s0
>>>>>>> tcontext=name:object_r:modules_object_t:s0 tclass=file
>>>>>>> [  100.675748] type=1300 audit(1273811633.675:20): arch=c000003e
>>>>>>> syscall=2 success=yes exit=3 a0=60d140 a1=0 a2=1b6 a3=0 items=0
>>>>>>> ppid=2080 pid=2168 auid=1000 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0
>>>>>>> sgid=0 fsgid=0 tty=pts0 ses=1 comm="modprobe" exe="/sbin/modprobe"
>>>>>>> subj=name:staff_r:staff_sudo_t:s0 key=(null)
>>>>>>> [  100.675902] type=1400 audit(1273811633.675:21): avc:  denied  {
>>>>>>> getattr } for  pid=2168 comm="modprobe"
>>>>>>> path="/lib/modules/2.6.34-rc7-00057-gcdfda35/modules.dep.bin" dev=sda3
>>>>>>> ino=525251 scontext=name:staff_r:staff_sudo_t:s0
>>>>>>> tcontext=name:object_r:modules_object_t:s0 tclass=file
>>>>>>> [  100.676052] type=1300 audit(1273811633.675:21): arch=c000003e
>>>>>>> syscall=5 success=yes exit=0 a0=3 a1=7fffd2d1dd70 a2=7fffd2d1dd70 a3=0
>>>>>>> items=0 ppid=2080 pid=2168 auid=1000 uid=0 gid=0 euid=0 suid=0 fsuid=0
>>>>>>> egid=0 sgid=0 fsgid=0 tty=pts0 ses=1 comm="modprobe"
>>>>>>> exe="/sbin/modprobe"
>>>>>>> subj=name:staff_r:staff_sudo_t:s0 key=(null)
>>>>>>> [  100.698392] ath9k 0000:03:00.0: PCI INT A ->    GSI 17 (level, low) ->
>>>>>>> IRQ 17
>>>>>>> [  100.698409] ath9k 0000:03:00.0: setting latency timer to 64
>>>>>>> [  100.828787] ath: EEPROM regdomain: 0x64
>>>>>>> [  100.828790] ath: EEPROM indicates we should expect a direct regpair
>>>>>>> map [  100.828793] ath: Country alpha2 being used: 00
>>>>>>> [  100.828795] ath: Regpair used: 0x64
>>>>>>> [  100.848609] type=1400 audit(1273811633.678:22): avc:  denied  {
>>>>>>> search } for  pid=2168 comm="modprobe" name="ieee80211" dev=debugfs
>>>>>>> ino=18 scontext=name:staff_r:staff_sudo_t:s0
>>>>>>> tcontext=system_u:object_r:debugfs_t:s0 tclass=dir
>>>>>>> [  100.848788] phy1: Selected rate control algorithm
>>>>>>> 'ath9k_rate_control' [  100.850035] Registered led device:
>>>>>>> ath9k-phy1::radio
>>>>>>> [  100.850488] Registered led device: ath9k-phy1::assoc
>>>>>>> [  100.851227] Registered led device: ath9k-phy1::tx
>>>>>>> [  100.851633] Registered led device: ath9k-phy1::rx
>>>>>>> [  100.851640] phy1: Atheros AR5418 MAC/BB Rev:2 AR5133 RF Rev:81
>>>>>>> mem=0xffffc900005a0000, irq=17
>>>>>>> [  100.852240] type=1300 audit(1273811633.678:22): arch=c000003e
>>>>>>> syscall=175 success=yes exit=0 a0=7f1e9d6ab010 a1=19580 a2=60d920 a3=0
>>>>>>> items=0 ppid=2080 pid=2168 auid=1000 uid=0 gid=0 euid=0 suid=0 fsuid=0
>>>>>>> egid=0 sgid=0 fsgid=0 tty=pts0 ses=1 comm="modprobe"
>>>>>>> exe="/sbin/modprobe"
>>>>>>> subj=name:staff_r:staff_sudo_t:s0 key=(null)
>>>>>>>
>>>>>>> but there you go dmesg of the debug info for you
>>>>>>
>>>>>> Justin, did you forget to use the debug parameter on modprobe ath9k?
>>>>>>
>>>>>> modprobe ath9k debug=0x0000020
>>>>>>
>>>>>> I do not see the output I expected.
>>>>>
>>>>> i think you have to do at least "ifconfig wlan0 up" to see it - (at least
>>>>> for ath5k).
>>>>>
>>>>> bruno
>>>>
>>>> didn't think todo so, I'll redu
>>>> again and see. BTW: the connection
>>>> over here is dodgy(hotel) should I at-least
>>>> find a stable access point? i.g. convetion
>>>> center seemed semi somewhat there
>>>
>>> no that does not matter. just ifconfig up is enough. it's just initialization,
>>> you don't need a connection for that.
>>>
>>> bruno
>>>
>>>> Justin P. Mattock
>>>> --
>>>> To unsubscribe from this list: send the line "unsubscribe linux-wireless"
>>>> in the body of a message to majordomo@vger.kernel.org
>>>> More majordomo info at  http://vger.kernel.org/majordomo-info.html
>>>
>>
>>
>> here you go:
>> (hopefully I did this correct)
>>
>> [   84.172542] ath9k 0000:03:00.0: PCI INT A disabled
>> [   84.172649] ath9k: Driver unloaded
>> [  100.675300] audit_printk_skb: 6 callbacks suppressed
>> [  100.675306] type=1400 audit(1273811633.675:20): avc:  denied  {
>> search } for  pid=2168 comm="modprobe" name="modules" dev=sda3 ino=2500
>>         xt=name:staff_r:staff_sudo_t:s0
>> tcontext=system_u:object_r:modules_object_t:s0 tclass=dir
>> [  100.675408] type=1400 audit(1273811633.675:20): avc:  denied  {
>> search } for  pid=2168 comm="modprobe" name="2.6.34-rc7-00057-gcdfda35"
>> dev=sda3 ino=524392 scontext=name:staff_r:staff_sudo_t:s0
>> tcontext=name:object_r:modules_object_t:s0 tclass=dir
>> [  100.675552] type=1400 audit(1273811633.675:20): avc:  denied  { read
>> } for  pid=2168 comm="modprobe" name="modules.dep.bin" dev=sda3
>> ino=525251 scontext=name:staff_r:staff_sudo_t:s0
>> tcontext=name:object_r:modules_object_t:s0 tclass=file
>> [  100.675598] type=1400 audit(1273811633.675:20): avc:  denied  { open
>> } for  pid=2168 comm="modprobe" name="modules.dep.bin" dev=sda3
>> ino=525251 scontext=name:staff_r:staff_sudo_t:s0
>> tcontext=name:object_r:modules_object_t:s0 tclass=file
>> [  100.675748] type=1300 audit(1273811633.675:20): arch=c000003e
>> syscall=2 success=yes exit=3 a0=60d140 a1=0 a2=1b6 a3=0 items=0
>> ppid=2080 pid=2168 auid=1000 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0
>> sgid=0 fsgid=0 tty=pts0 ses=1 comm="modprobe" exe="/sbin/modprobe"
>> subj=name:staff_r:staff_sudo_t:s0 key=(null)
>> [  100.675902] type=1400 audit(1273811633.675:21): avc:  denied  {
>> getattr } for  pid=2168 comm="modprobe"
>> path="/lib/modules/2.6.34-rc7-00057-gcdfda35/modules.dep.bin" dev=sda3
>> ino=525251 scontext=name:staff_r:staff_sudo_t:s0
>> tcontext=name:object_r:modules_object_t:s0 tclass=file
>> [  100.676052] type=1300 audit(1273811633.675:21): arch=c000003e
>> syscall=5 success=yes exit=0 a0=3 a1=7fffd2d1dd70 a2=7fffd2d1dd70 a3=0
>> items=0 ppid=2080 pid=2168 auid=1000 uid=0 gid=0 euid=0 suid=0 fsuid=0
>> egid=0 sgid=0 fsgid=0 tty=pts0 ses=1 comm="modprobe"
>> exe="/sbin/modprobe" subj=name:staff_r:staff_sudo_t:s0 key=(null)
>> [  100.698392] ath9k 0000:03:00.0: PCI INT A ->  GSI 17 (level, low) ->
>> IRQ 17
>> [  100.698409] ath9k 0000:03:00.0: setting latency timer to 64
>> [  100.828787] ath: EEPROM regdomain: 0x64
>> [  100.828790] ath: EEPROM indicates we should expect a direct regpair map
>> [  100.828793] ath: Country alpha2 being used: 00
>> [  100.828795] ath: Regpair used: 0x64
>>
>> [  100.848609] type=1400 audit(1273811633.678:22): avc:  denied  {
>> search } for  pid=2168 comm="modprobe" name="ieee80211" dev=debugfs
>> ino=18 scontext=name:staff_r:staff_sudo_t:s0
>> tcontext=system_u:object_r:debugfs_t:s0 tclass=dir
>> [  100.848788] phy1: Selected rate control algorithm 'ath9k_rate_control'
>> [  100.850035] Registered led device: ath9k-phy1::radio
>> [  100.850488] Registered led device: ath9k-phy1::assoc
>> [  100.851227] Registered led device: ath9k-phy1::tx
>> [  100.851633] Registered led device: ath9k-phy1::rx
>> [  100.851640] phy1: Atheros AR5418 MAC/BB Rev:2 AR5133 RF Rev:81
>> mem=0xffffc900005a0000, irq=17
>> [  100.852240] type=1300 audit(1273811633.678:22): arch=c000003e
>> syscall=175 success=yes exit=0 a0=7f1e9d6ab010 a1=19580 a2=60d920 a3=0
>> items=0 ppid=2080 pid=2168 auid=1000 uid=0 gid=0 euid=0 suid=0 fsuid=0
>> egid=0 sgid=0 fsgid=0 tty=pts0 ses=1 comm="modprobe"
>> exe="/sbin/modprobe" subj=name:staff_r:staff_sudo_t:s0 key=(null)
>>
>>
>> let me know if you need more info.. I'll be off the grid in
>> a few, then probably wont be back on till a while
>> (since I aint got's no 99 big ones for intranet!!)
>
> Your output still did not have the stuff I was looking for, just do:
>
> dmesg | grep cachelsz
>
> If nothing comes up it doesn't have the output I was looking for yet.
>
>    Luis
>


here you go:
(I was grabbing the info
after rmmod and modprobe)

[    7.034242] ATH9K: cachelsz: 256
[   69.175348] ATH9K: cachelsz: 256



Justin P. Mattock