nfs: server 192.168.0.3 not responding, still trying

yftljj

2009-10-24 16:55

按照shinelk提供的android移植可以在nandflash 上运行看到大钟！
但是通过nfs只能看见 “ANDROID”字符，停在那了，错误如下
IP-Config: Complete:
device=eth0, addr=192.168.0.7, mask=255.255.255.0, gw=192.168.0.1,
host=192.168.0.7, domain=, nis-domain=(none),
bootserver=192.168.0.3, rootserver=192.168.0.3, rootpath=
Looking up port of RPC 100003/2 on 192.168.0.3
eth0: link up, 100Mbps, full-duplex, lpa 0x4DE1
Looking up port of RPC 100005/1 on 192.168.0.3
VFS: Mounted root (nfs filesystem).
Freeing init memory: 116K
ts is ok!
ts_control_open!
ts_control_release!
init: cannot open '/initlogo.rle'
sh: can't access tty; job control turned off
/ # init: cannot find '/system/bin/playmp3', disabling 'bootsound'
warning: `rild' uses 32-bit capabilities (legacy support in use)
nfs: server 192.168.0.3 not responding, still trying
nfs: server 192.168.0.3 not responding, still trying

yftljj	2009-10-26 09:39
已经解决 nfs支持不太好启动android文件系统的时候不断执行一下命令就可以了 #/etc/init.d/nfs-kernel-server restart

rake_zhm

2009-11-02 23:56

我也遇到同样的问题，android采用nfs root启动的时候，串口输出
warning: `rild' uses 32-bit capabilities (legacy support in use)
nfs: server 192.168.0.3 not responding, still trying

本以为是开发板网卡丢包的问题，于是设置cmdline为“nfsroot=ip:/rootfs, rsize=1024,wsize=1024,intr, nolock ”但还是不能解决问题。

这时候我在vmware的linux上Ping开发板，不通，说明开发板上的网络已经有问题了。还没有试验楼主的方法，但是直觉上感觉不能解决问题啊。

speeddy	2009-11-03 07:23
我也遇到一样的问题了，Linux根本Ping不到开发板，很奇怪，请问怎么解决阿？

yftljj

2009-11-03 09:42

我试了不行是我搞错后来我发现我能成功的是挂载的yaffs2而不是nfs 原来是参数修改没成功
现在一直在找这个的解决办法在网上找了很多办法该用tcp协议来防止丢包结果都没成功
没有nfs挂载开发很起来很不方便每次都要烧
虽然使用模拟器仿真但是模拟器和板差别较大最终还是要到板上调试
希望 shinelk 能出面解决一下我们这个难题。

speeddy	2009-11-03 11:57
但是为什么后来你又说解决了呢？我在怀疑是不是DM9000c的Driver有问题，因为我有快Ti的板子，很轻易的就可以nfs启动了。

rake_zhm	2009-11-03 14:08
晚上回家再做一下试验，把dm9000和nfs的debug宏打开，输出打印语句，看看究竟是什么问题。现在怀疑的目标是，在根文件系统中的配置文件：init.rc,init_goldfish.rc内，重新设置了开发板的IP地址，导致采用NFS启动到一半的时候不能从HOST正确获得后续的文件和数据。

speeddy	2009-11-03 14:35
我刚把\etc\init.d下的 rcS 里面的 /sbin/ifconfig lo 127.0.0.1/etc/init.d/ifconfig-eth0 去掉以后，现在可以启动了linux了，但是启动以后，主机的终端窗口Hang住了，打不进去Command了，很奇怪。

kasim	2009-11-03 14:42
这个分析很有道理

yftljj

2009-11-03 17:22

最新进展
仔细分析启动脚本init.rc发现
waner@waner:/mini2440/android_nfs$ vim fs/init.rc
service myInit /bin/busybox sh /system/etc/shine/myInit.rc
以上行最后要执行fs/system/etc/shine/net.conf文件

waner@waner:/mini2440/android_nfs$ vim fs/system/etc/shine/net.conf
1 NET=eth0
2 IP=192.168.1.230
3 GW=192.168.1.1
4 DNS=192.168.1.1
以上修改为，其中192.168.0.7为目标板IP
1 NET=eth0
2 IP=192.168.0.7
3 GW=192.168.0.1
4 DNS=192.168.0.1
就不会出现NFS错误，但是出现机器人不断重启，还没有查出是什么原因导致的

（不过我同时还需要更改nfs的设置，
在/etc/exports的共享目录中添加no_root_squash属性
例如：/home/alan/nfs_dir *(rw,sync,no_root_squash,no_all_squash,no_subtree_check,insecure)
)

rake_zhm	2009-11-03 17:44
有道理。这是因为友善的文件系统增加了一些东西而导致ip地址与个人配置的不一样而NFS失败。但为什么我用从emulator上获取的文件系统也同样出现 not responding, still trying 的提示呢？还是得仔细研究研究。

yftljj

2009-11-03 20:51

nfs问题已经解决就是按我上面的办法
但是出现机器人不断在那里启动就是进入不了最后的大钟
在目标机上用logcat命令查看后出现下面的信息
希望一起研究解决这个问题

VFS: Mounted root (nfs filesystem).
Freeing init memory: 116K
mknod: /myDev/ts0: File exists
mknod: /myDev/fb0: File exists
mknod: /myDev/ts_ctl: File exists
ts is ok!
ts_control_open!
ts_control_release!
init: cannot open '/initlogo.rle'
sh: can't access tty; job control turned off
/ # init: cannot find '/system/bin/playmp3', disabling 'bootsound'
warning: `rild' uses 32-bit capabilities (legacy support in use)

/ # logcat
I/DEBUG (737): debuggerd: May 13 2009 23:22:59
E/flash_image(746): can't find recovery partition
D/mountd(736): AddMountPoint device: /dev/block/mmcblk0p1, mountPoint: /sdcard driverStorePath: /sye
E/mountd(736): could not read initial mass storage state
D/mountd(736): USB offline
D/mountd(736): RequestMount /sdcard
E/mountd(736): inotify_init failed, Function not implemented
D/AndroidRuntime(739):
D/AndroidRuntime(739): >>>>>>>>>>>>>> AndroidRuntime START <<<<<<<<<<<<<<
D/AndroidRuntime(739): CheckJNI is ON
I/(740): ServiceManager: 0xabe0
I/AudioFlinger(740): AudioFlinger's main thread ready to run.
I/CameraService(740): CameraService started: pid=740
D/AndroidRuntime(739): --- registering native functions ---
I/Zygote(739): Preloading classes...
D/dalvikvm(739): GC freed 763 objects / 42112 bytes in 12ms
D/dalvikvm(739): GC freed 280 objects / 17456 bytes in 12ms
D/dalvikvm(739): GC freed 306 objects / 18656 bytes in 14ms
D/dalvikvm(739): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(739): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(739): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(739): Added shared lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(739): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(739): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(739): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(739): Shared lib '/system/lib/libmedia_jni.so' already loaded in same CL 0x0
D/dalvikvm(739): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(739): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(739): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(739): Shared lib '/system/lib/libmedia_jni.so' already loaded in same CL 0x0
D/dalvikvm(739): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(739): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(739): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(739): Shared lib '/system/lib/libmedia_jni.so' already loaded in same CL 0x0
D/dalvikvm(739): GC freed 3739 objects / 177928 bytes in 36ms
D/dalvikvm(739): GC freed 328 objects / 26232 bytes in 32ms
D/dalvikvm(739): GC freed 375 objects / 22576 bytes in 34ms
D/dalvikvm(739): GC freed 199 objects / 29728 bytes in 35ms
D/dalvikvm(739): GC freed 102 objects / 23888 bytes in 55ms
D/dalvikvm(739): GC freed 379 objects / 23360 bytes in 58ms
D/dalvikvm(739): Trying to load lib /lib/libwebcore.so 0x0
I/dalvikvm(739): Unable to dlopen(/lib/libwebcore.so): Cannot find library
D/dalvikvm(739): Trying to load lib /system/lib/libwebcore.so 0x0
D/dalvikvm(739): Added shared lib /system/lib/libwebcore.so 0x0
D/dalvikvm(739): GC freed 452 objects / 28368 bytes in 59ms
D/dalvikvm(739): GC freed 380 objects / 26080 bytes in 62ms
D/dalvikvm(739): GC freed 292 objects / 19320 bytes in 64ms
D/dalvikvm(739): GC freed 2149 objects / 112360 bytes in 71ms
D/dalvikvm(739): GC freed 556 objects / 42952 bytes in 69ms
D/dalvikvm(739): GC freed 14030 objects / 489968 bytes in 95ms
D/dalvikvm(739): GC freed 10951 objects / 459512 bytes in 98ms
D/SSLSocketFactory(739): Using factory org.apache.harmony.xnet.provider.jsse.OpenSSLSocketFactoryImpl0
D/dalvikvm(739): GC freed 6407 objects / 273312 bytes in 94ms
D/dalvikvm(739): GC freed 645 objects / 35192 bytes in 86ms
D/dalvikvm(739): GC freed 590 objects / 30568 bytes in 90ms
D/dalvikvm(739): GC freed 372 objects / 26328 bytes in 91ms
I/Zygote(739): ...preloaded 909 classes in 13222ms.
D/dalvikvm(739): GC freed 41 objects / 2384 bytes in 93ms
I/Zygote(739): Preloading resources...
D/dalvikvm(739): GC freed 6 objects / 8928 bytes in 91ms
D/dalvikvm(739): GC freed 198 objects / 10184 bytes in 94ms
D/dalvikvm(739): GC freed 253 objects / 10200 bytes in 95ms
I/Zygote(739): ...preloaded 42 resources in 1260ms.
D/dalvikvm(739): GC freed 15 objects / 1704 bytes in 95ms
D/dalvikvm(739): GC freed 99 objects / 3912 bytes in 94ms
D/dalvikvm(739): GC freed 30 objects / 1112 bytes in 94ms
I/dalvikvm(739): Splitting out new zygote heap
I/dalvikvm(739): System server process 763 has been created
I/Zygote(739): Accepting command socket connections
D/dalvikvm(763): Trying to load lib /lib/libandroid_servers.so 0x0
I/dalvikvm(763): Unable to dlopen(/lib/libandroid_servers.so): Cannot find library
D/dalvikvm(763): Trying to load lib /system/lib/libandroid_servers.so 0x0
D/dalvikvm(763): Added shared lib /system/lib/libandroid_servers.so 0x0
I/sysproc (763): Entered system_init()
I/sysproc (763): ServiceManager: 0xc9a48
I/SurfaceFlinger(763): SurfaceFlinger is starting
I/SurfaceFlinger(763): SurfaceFlinger's main thread ready to run. Initializing graphics H/W...
E/MemoryHeapBase(763): error opening /dev/pmem: No such file or directory
E/SurfaceFlinger(763): Couldn't open /sys/power/wait_for_fb_sleep or /sys/power/wait_for_fb_wake
E/GLLogger(763): couldn't load <libhgl.so> library (Cannot find library)
I/SurfaceFlinger(763): EGL informations:
I/SurfaceFlinger(763): # of configs : 6
I/SurfaceFlinger(763): vendor: Android
I/SurfaceFlinger(763): version : 1.3 Android META-EGL
I/SurfaceFlinger(763): extensions: EGL_ANDROID_query_string_config EGL_ANDROID_swap_rectangle
I/SurfaceFlinger(763): ext/config: EGL_ANDROID_swap_rectangle
I/SurfaceFlinger(763): Client API: OpenGL ES
W/EGLDisplaySurface(763): FBIOPUT_VSCREENINFO failed, page flipping not supported
W/EGLDisplaySurface(763): page flipping not supported (yres_virtual=320, requested=640)
I/EGLDisplaySurface(763): using (fd=21)
I/EGLDisplaySurface(763): id = s3c2410fb
I/EGLDisplaySurface(763): xres = 240 px
I/EGLDisplaySurface(763): yres = 320 px
I/EGLDisplaySurface(763): xres_virtual = 240 px
I/EGLDisplaySurface(763): yres_virtual = 320 px
I/EGLDisplaySurface(763): bpp= 16
I/EGLDisplaySurface(763): r= 11:5
I/EGLDisplaySurface(763): g=5:6
I/EGLDisplaySurface(763): b=0:5
I/EGLDisplaySurface(763): width= 240 mm (25.400000 dpi)
I/EGLDisplaySurface(763): height = 320 mm (25.400000 dpi)
I/EGLDisplaySurface(763): refresh rate = 63.44 Hz
W/SurfaceFlinger(763): ro.sf.lcd_density not defined, using 160 dpi by default.
I/SurfaceFlinger(763): OpenGL informations:
I/SurfaceFlinger(763): vendor: Android
I/SurfaceFlinger(763): renderer: Android PixelFlinger 1.0
I/SurfaceFlinger(763): version : OpenGL ES-CM 1.0
I/SurfaceFlinger(763): extensions: GL_OES_byte_coordinates GL_OES_fixed_point GL_OES_single_precision
I/sysproc (763): System server: starting Android runtime.
I/sysproc (763): System server: starting Android services.
I/SystemServer(763): Entered the Android system server!
I/sysproc (763): System server: entering thread pool.
E/GLLogger(763): couldn't load <libhgl.so> library (Cannot find library)
I/SystemServer(763): Starting Power Manager.
I/SystemServer(763): Starting Activity Manager.
I/SystemServer(763): Starting telephony registry
I/SystemServer(763): Starting Package Manager.
I/Installer(763): connecting...
I/installd(745): new connection
I/PackageManager(763): Got library android.awt in /system/framework/android.awt.jar
I/PackageManager(763): Got library android.test.runner in /system/framework/android.test.runner.jar
I/PackageManager(763): Got library com.android.im.plugin in /system/framework/com.android.im.plugin.jr
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@com.android.im.plugin.jar@c'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@android.test.runner.jar@cla'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@android.awt.jar@classes.dex'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@am.jar@classes.dex'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@monkey.jar@classes.dex'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@framework-tests.jar@classes'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@pm.jar@classes.dex'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@ime.jar@classes.dex'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@input.jar@classes.dex'
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@framework@svc.jar@classes.dex'
E/(763): ***** ERROR! android_os_fileobserver_observe() got a short event!
D/PackageManager(763): Scanning app dir /system/framework
D/PackageManager(763): Scanning app dir /system/app
W/PackageManager(763): System package com.android.providers.settings has changed from uid: 65534 to 1d
E/installd(745): cannot chown dir '/data/data/com.android.providers.settings': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@SettingsProvider.apk@classes.dex'
D/dalvikvm(763): GC freed 5469 objects / 234328 bytes in 218ms
W/PackageManager(763): System package com.android.settings has changed from uid: 65534 to 1000; old dd
E/installd(745): cannot chown dir '/data/data/com.android.settings': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@Settings.apk@classes.dex'
W/PackageManager(763): System package com.android.music has changed from uid: 65534 to 10000; old datd
E/installd(745): cannot chown dir '/data/data/com.android.music': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@Music.apk@classes.dex'
W/PackageManager(763): System package com.android.phone has changed from uid: 65534 to 1001; old datad
E/installd(745): cannot chown dir '/data/data/com.android.phone': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@Phone.apk@classes.dex'
W/PackageManager(763): System package com.android.camera has changed from uid: 65534 to 10001; old dad
E/installd(745): cannot chown dir '/data/data/com.android.camera': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@Camera.apk@classes.dex'
W/PackageManager(763): System package com.android.htmlviewer has changed from uid: 65534 to 10002; old
E/installd(745): cannot chown dir '/data/data/com.android.htmlviewer': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@HTMLViewer.apk@classes.dex'
W/PackageManager(763): System package com.example.android.softkeyboard has changed from uid: 65534 tod
E/installd(745): cannot chown dir '/data/data/com.example.android.softkeyboard': Operation not permitd
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@SoftKeyboard.apk@classes.dex'
W/PackageManager(763): System package com.android.launcher has changed from uid: 65534 to 10004; old d
E/installd(745): cannot chown dir '/data/data/com.android.launcher': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@Launcher.apk@classes.dex'
W/PackageManager(763): System package com.android123.apkInstaller has changed from uid: 65534 to 1000d
E/installd(745): cannot chown dir '/data/data/com.android123.apkInstaller': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@apkInstaller.apk@classes.dex'
W/PackageManager(763): System package com.android.browser has changed from uid: 65534 to 10006; old dd
E/installd(745): cannot chown dir '/data/data/com.android.browser': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@Browser.apk@classes.dex'
W/PackageManager(763): System package com.android.providers.media has changed from uid: 65534 to 1000d
E/installd(745): cannot chown dir '/data/data/com.android.providers.media': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@MediaProvider.apk@classes.dex'
W/PackageManager(763): System package com.android.packageinstaller has changed from uid: 65534 to 100d
E/installd(745): cannot chown dir '/data/data/com.android.packageinstaller': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@PackageInstaller.apk@classes.dex'
W/PackageManager(763): System package com.android.soundrecorder has changed from uid: 65534 to 10008;d
E/installd(745): cannot chown dir '/data/data/com.android.soundrecorder': Operation not permitted
E/installd(745): dexopt cannot chown '/data/dalvik-cache/system@app@SoundRecorder.apk@classes.dex'
D/PackageManager(763): Scanning app dir /data/app
D/PackageManager(763): Scanning app dir /data/app-private
I/PackageManager(763): Time to scan packages: 11.325 seconds
W/PackageManager(763): Removing dangling permission: android.permission.ACCESS_CACHE_FILESYSTEM from l
W/PackageManager(763): Not granting permission android.permission.INSTALL_PACKAGES to package com.and)
W/PackageManager(763): Not granting permission android.permission.DELETE_PACKAGES to package com.andr)
W/PackageManager(763): Unknown permission com.android.launcher.permission.READ_SETTINGS in package cor
W/PackageManager(763): Unknown permission com.android.launcher.permission.WRITE_SETTINGS in package cr
W/PackageManager(763): Unknown permission com.google.android.providers.gmail.permission.WRITE_GMAIL is
W/PackageManager(763): Unknown permission com.google.android.providers.gmail.permission.READ_GMAIL ins
W/PackageManager(763): Unknown permission com.google.android.googleapps.permission.GOOGLE_AUTH in pacs
W/PackageManager(763): Unknown permission android.permission.ACCESS_DOWNLOAD_MANAGER in package com.as
W/PackageManager(763): Unknown permission com.google.android.googleapps.permission.GOOGLE_AUTH in pacr
W/PackageManager(763): Unknown permission android.permission.ACCESS_DOWNLOAD_MANAGER in package com.ar
W/PackageManager(763): Unknown permission com.android.launcher.permission.INSTALL_SHORTCUT in packager
W/PackageManager(763): Unknown permission com.android.browser.permission.READ_HISTORY_BOOKMARKS in par
W/PackageManager(763): Unknown permission com.android.browser.permission.WRITE_HISTORY_BOOKMARKS in pr
D/dalvikvm(763): GC freed 3240 objects / 216616 bytes in 211ms
I/SystemServer(763): Starting Content Manager.
W/ActivityManager(763): Unable to start service Intent { action=android.accounts.IAccountsService comd
W/AccountMonitor(763): Couldn't connect to Intent { action=android.accounts.IAccountsService comp={co)
I/SystemServer(763): Starting System Content Providers.
I/ActivityThread(763): Publishing provider android.server.checkin: android.server.checkin.CheckinProvr
I/ActivityThread(763): Publishing provider sync: android.content.SyncProvider
I/SystemServer(763): Starting Battery Service.
E/BatteryService(763): Could not open '/sys/class/power_supply/ac/online'
E/BatteryService(763): Could not open '/sys/class/power_supply/usb/online'
E/BatteryService(763): Could not open '/sys/class/power_supply/battery/present'
E/BatteryService(763): Could not open '/sys/class/power_supply/battery/capacity'
E/BatteryService(763): Could not open '/sys/class/power_supply/battery/batt_vol'
E/BatteryService(763): Could not open '/sys/class/power_supply/battery/batt_temp'
E/BatteryService(763): Could not open '/sys/class/power_supply/battery/status'
E/BatteryService(763): Could not open '/sys/class/power_supply/battery/health'
E/BatteryService(763): Could not open '/sys/class/power_supply/battery/technology'
E/ActivityThread(763): Failed to find provider info for settings
W/dalvikvm(763): threadid=27: thread exiting with uncaught exception (group=0x4000fe68)
E/AndroidRuntime(763): Uncaught handler: thread PowerManagerService exiting due to uncaught exception
E/AndroidRuntime(763): *** EXCEPTION IN SYSTEM PROCESS.System will crash.
E/AndroidRuntime(763): java.lang.NullPointerException
E/AndroidRuntime(763):at android.content.ContentQueryMap.<init>(ContentQueryMap.java:65)
E/AndroidRuntime(763):at com.android.server.PowerManagerService.initInThread(PowerManagerServ)
E/AndroidRuntime(763):at com.android.server.PowerManagerService$1.onLooperPrepared(PowerManag)
E/AndroidRuntime(763):at android.os.HandlerThread.run(HandlerThread.java:59)
E/AndroidRuntime(763): Crash logging skipped, no checkin service
I/Process (763): Sending signal. PID: 763 SIG: 9
I/ServiceManager(734): service 'activity.broadcasts' died
I/ServiceManager(734): service 'activity.services' died
I/ServiceManager(734): service 'SurfaceFlinger' died
I/ServiceManager(734): service 'permission' died
I/ServiceManager(734): service 'batteryinfo' died
I/ServiceManager(734): service 'telephony.registry' died
I/ServiceManager(734): service 'power' died
I/ServiceManager(734): service 'package' died
I/ServiceManager(734): service 'activity' died
I/ServiceManager(734): service 'activity.senders' died
I/ServiceManager(734): service 'meminfo' died
I/ServiceManager(734): service 'cpuinfo' died
I/ServiceManager(734): service 'activity.providers' died
I/ServiceManager(734): service 'content' died
I/ServiceManager(734): service 'battery' died
E/installd(745): eof
E/installd(745): failed to read size
I/installd(745): closing connection
I/Zygote(739): Exit zygote because system server (763) has terminated
D/AndroidRuntime(791):
D/AndroidRuntime(791): >>>>>>>>>>>>>> AndroidRuntime START <<<<<<<<<<<<<<
D/AndroidRuntime(791): CheckJNI is ON

kasim	2009-11-03 21:40
注意看logcat里所有"E/"打头的信息，这些是出错信息。对比一下用NAND Flash中的文件系统正常启动时候的logcat输出就能找到错误的原因。

rake_zhm

2009-11-04 00:12

请问yftljj你可以通过串口打开console了吗？

我按你的方法，修改了net.conf文件之后，可以从nfs启动了。

但是串口还是继续输出
nfs: server 192.168.0.3 not responding, still trying

的信息，这时修改cmd_line，将nfs的启动参数从默认的udp改为tcp，会执行一大堆初始化的
动作，然后就会一直打印zygote服务的信息，似乎定时会处理一些event

这时可以输出命令了，也就是说基本上启动成功；由于我的lcd驱动还没有移植好，所以看不到任何画面，下一步的工作就是移植lcd和fb。

yftljj

2009-11-04 18:21

今天查了一天没查出来是什么问题导致机器人一直重启动
但是根据logout信息可以查明是电源管理程序的电池服务没起来导致的
希望大家看看有什么解决的办法

下面是从nandflash正常启动到看到大钟时的是logcat
D/AndroidRuntime(740): >>>>>>>>>>>>>> AndroidRuntime START <<<<<<<<<<<<<<
D/AndroidRuntime(740): CheckJNI is ON
I/(741): ServiceManager: 0xabe0
I/AudioFlinger(741): AudioFlinger's main thread ready to run.
I/CameraService(741): CameraService started: pid=741
D/AndroidRuntime(740): --- registering native functions ---
I/Zygote(740): Preloading classes...
D/dalvikvm(740): GC freed 763 objects / 42112 bytes in 7ms
D/dalvikvm(740): GC freed 280 objects / 17456 bytes in 7ms
D/dalvikvm(740): GC freed 306 objects / 18656 bytes in 8ms
D/dalvikvm(740): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(740): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(740): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(740): Added shared lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(740): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(740): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(740): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(740): Shared lib '/system/lib/libmedia_jni.so' already loaded in same CL 0x0
D/dalvikvm(740): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(740): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(740): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(740): Shared lib '/system/lib/libmedia_jni.so' already loaded in same CL 0x0
D/dalvikvm(740): Trying to load lib /lib/libmedia_jni.so 0x0
I/dalvikvm(740): Unable to dlopen(/lib/libmedia_jni.so): Cannot find library
D/dalvikvm(740): Trying to load lib /system/lib/libmedia_jni.so 0x0
D/dalvikvm(740): Shared lib '/system/lib/libmedia_jni.so' already loaded in same CL 0x0
D/dalvikvm(740): GC freed 3739 objects / 177928 bytes in 23ms
D/dalvikvm(740): GC freed 328 objects / 26232 bytes in 20ms
D/dalvikvm(740): GC freed 375 objects / 22576 bytes in 21ms
D/dalvikvm(740): GC freed 199 objects / 29728 bytes in 22ms
D/dalvikvm(740): GC freed 102 objects / 23888 bytes in 36ms
D/dalvikvm(740): GC freed 379 objects / 23360 bytes in 37ms
D/dalvikvm(740): Trying to load lib /lib/libwebcore.so 0x0
I/dalvikvm(740): Unable to dlopen(/lib/libwebcore.so): Cannot find library
D/dalvikvm(740): Trying to load lib /system/lib/libwebcore.so 0x0
D/dalvikvm(740): Added shared lib /system/lib/libwebcore.so 0x0
D/dalvikvm(740): GC freed 452 objects / 28368 bytes in 38ms
D/dalvikvm(740): GC freed 380 objects / 26080 bytes in 39ms
D/dalvikvm(740): GC freed 292 objects / 19320 bytes in 41ms
D/dalvikvm(740): GC freed 2149 objects / 112360 bytes in 45ms
D/dalvikvm(740): GC freed 556 objects / 42952 bytes in 44ms
D/dalvikvm(740): GC freed 14030 objects / 489968 bytes in 64ms
D/dalvikvm(740): GC freed 10951 objects / 459512 bytes in 64ms
D/SSLSocketFactory(740): Using factory org.apache.harmony.xnet.provider.jsse.OpenSSLSocketFactoryImpl@40130ad0
D/dalvikvm(740): GC freed 6407 objects / 273312 bytes in 61ms
D/dalvikvm(740): GC freed 645 objects / 35192 bytes in 55ms
D/dalvikvm(740): GC freed 590 objects / 30568 bytes in 58ms
D/dalvikvm(740): GC freed 372 objects / 26328 bytes in 59ms
I/Zygote(740): ...preloaded 909 classes in 6391ms.
D/dalvikvm(740): GC freed 41 objects / 2384 bytes in 58ms
I/Zygote(740): Preloading resources...
D/dalvikvm(740): GC freed 6 objects / 8928 bytes in 58ms
D/dalvikvm(740): GC freed 198 objects / 10184 bytes in 60ms
D/dalvikvm(740): GC freed 253 objects / 10200 bytes in 61ms
I/Zygote(740): ...preloaded 42 resources in 655ms.
D/dalvikvm(740): GC freed 15 objects / 1704 bytes in 61ms
D/dalvikvm(740): GC freed 99 objects / 3912 bytes in 60ms
D/dalvikvm(740): GC freed 30 objects / 1112 bytes in 60ms
I/dalvikvm(740): Splitting out new zygote heap
I/dalvikvm(740): System server process 762 has been created
I/Zygote(740): Accepting command socket connections
D/dalvikvm(762): Trying to load lib /lib/libandroid_servers.so 0x0
I/dalvikvm(762): Unable to dlopen(/lib/libandroid_servers.so): Cannot find library
D/dalvikvm(762): Trying to load lib /system/lib/libandroid_servers.so 0x0
D/dalvikvm(762): Added shared lib /system/lib/libandroid_servers.so 0x0
I/sysproc (762): Entered system_init()
I/sysproc (762): ServiceManager: 0xce810
I/SurfaceFlinger(762): SurfaceFlinger is starting
I/SurfaceFlinger(762): SurfaceFlinger's main thread ready to run. Initializing graphics H/W...
E/MemoryHeapBase(762): error opening /dev/pmem: No such file or directory
E/SurfaceFlinger(762): Couldn't open /sys/power/wait_for_fb_sleep or /sys/power/wait_for_fb_wake
E/GLLogger(762): couldn't load <libhgl.so> library (Cannot find library)
I/SurfaceFlinger(762): EGL informations:
I/SurfaceFlinger(762): # of configs : 6
I/SurfaceFlinger(762): vendor: Android
I/SurfaceFlinger(762): version : 1.3 Android META-EGL
I/SurfaceFlinger(762): extensions: EGL_ANDROID_query_string_config EGL_ANDROID_swap_rectangle
I/SurfaceFlinger(762): ext/config: EGL_ANDROID_swap_rectangle
I/SurfaceFlinger(762): Client API: OpenGL ES
W/EGLDisplaySurface(762): FBIOPUT_VSCREENINFO failed, page flipping not supported
W/EGLDisplaySurface(762): page flipping not supported (yres_virtual=320, requested=640)
I/EGLDisplaySurface(762): using (fd=21)
I/EGLDisplaySurface(762): id = s3c2410fb
I/EGLDisplaySurface(762): xres = 240 px
I/EGLDisplaySurface(762): yres = 320 px
I/EGLDisplaySurface(762): xres_virtual = 240 px
I/EGLDisplaySurface(762): yres_virtual = 320 px
I/EGLDisplaySurface(762): bpp= 16
I/EGLDisplaySurface(762): r= 11:5
I/EGLDisplaySurface(762): g=5:6
I/EGLDisplaySurface(762): b=0:5
I/EGLDisplaySurface(762): width= 240 mm (25.400000 dpi)
I/EGLDisplaySurface(762): height = 320 mm (25.400000 dpi)
I/EGLDisplaySurface(762): refresh rate = 63.44 Hz
W/SurfaceFlinger(762): ro.sf.lcd_density not defined, using 160 dpi by default.
I/SurfaceFlinger(762): OpenGL informations:
I/SurfaceFlinger(762): vendor: Android
I/SurfaceFlinger(762): renderer: Android PixelFlinger 1.0
I/SurfaceFlinger(762): version : OpenGL ES-CM 1.0
I/SurfaceFlinger(762): extensions: GL_OES_byte_coordinates GL_OES_fixed_point GL_OES_single_precision GL_OES_read_format GL_OES_compressed_paletted_texture GL_OES_draw_texture GL_OES_matrix_get GL_OES_query_matrix GL_ARB_texture_compression GL_ARB_texture_non_power_of_two GL_ANDROID_direct_texture GL_ANDROID_user_clip_plane GL_ANDROID_vertex_buffer_object GL_ANDROID_generate_mipmap
I/sysproc (762): System server: starting Android runtime.
I/sysproc (762): System server: starting Android services.
I/SystemServer(762): Entered the Android system server!
I/sysproc (762): System server: entering thread pool.
E/GLLogger(762): couldn't load <libhgl.so> library (Cannot find library)
I/SystemServer(762): Starting Power Manager.
I/SystemServer(762): Starting Activity Manager.
I/SystemServer(762): Starting telephony registry
I/SystemServer(762): Starting Package Manager.
I/Installer(762): connecting...
I/installd(746): new connection
I/PackageManager(762): Got library android.awt in /system/framework/android.awt.jar
I/PackageManager(762): Got library android.test.runner in /system/framework/android.test.runner.jar
I/PackageManager(762): Got library com.android.im.plugin in /system/framework/com.android.im.plugin.jar
E/(762): ***** ERROR! android_os_fileobserver_observe() got a short event!
D/PackageManager(762): Scanning app dir /system/framework
D/PackageManager(762): Scanning app dir /system/app
D/dalvikvm(762): GC freed 5407 objects / 231008 bytes in 352ms
D/PackageManager(762): Scanning app dir /data/app
D/PackageManager(762): Scanning app dir /data/app-private
I/PackageManager(762): Time to scan packages: 5.418 seconds
W/PackageManager(762): Removing dangling permission: android.permission.ACCESS_CACHE_FILESYSTEM from package null
W/PackageManager(762): Not granting permission android.permission.INSTALL_PACKAGES to package com.android123.apkInstaller (protectionLevel=2 flags=0x45)
W/PackageManager(762): Not granting permission android.permission.DELETE_PACKAGES to package com.android123.apkInstaller (protectionLevel=2 flags=0x45)
W/PackageManager(762): Unknown permission com.google.android.providers.gmail.permission.WRITE_GMAIL in package com.android.settings
W/PackageManager(762): Unknown permission com.google.android.providers.gmail.permission.READ_GMAIL in package com.android.settings
W/PackageManager(762): Unknown permission com.google.android.googleapps.permission.GOOGLE_AUTH in package com.android.settings
W/PackageManager(762): Unknown permission android.permission.ACCESS_DOWNLOAD_MANAGER in package com.android.settings
W/PackageManager(762): Unknown permission com.google.android.googleapps.permission.GOOGLE_AUTH in package com.android.browser
W/PackageManager(762): Unknown permission android.permission.ACCESS_DOWNLOAD_MANAGER in package com.android.browser
D/dalvikvm(762): GC freed 2071 objects / 147512 bytes in 155ms
I/SystemServer(762): Starting Content Manager.
W/ActivityManager(762): Unable to start service Intent { action=android.accounts.IAccountsService comp={com.google.android.googleapps/com.google.android.googleapps.GoogleLoginService} }: not found
W/AccountMonitor(762): Couldn't connect to Intent { action=android.accounts.IAccountsService comp={com.google.android.googleapps/com.google.android.googleapps.GoogleLoginService} } (Missing service?)
I/SystemServer(762): Starting System Content Providers.
I/ActivityThread(762): Publishing provider settings: com.android.providers.settings.SettingsProvider
I/ActivityThread(762): Publishing provider android.server.checkin: android.server.checkin.CheckinProvider
I/ActivityThread(762): Publishing provider sync: android.content.SyncProvider
I/SystemServer(762): Starting Battery Service.
E/BatteryService(762): Could not open '/sys/class/power_supply/ac/online'
E/BatteryService(762): Could not open '/sys/class/power_supply/usb/online'
E/BatteryService(762): Could not open '/sys/class/power_supply/battery/present'
E/BatteryService(762): Could not open '/sys/class/power_supply/battery/capacity'
E/BatteryService(762): Could not open '/sys/class/power_supply/battery/batt_vol'
E/BatteryService(762): Could not open '/sys/class/power_supply/battery/batt_temp'
E/BatteryService(762): Could not open '/sys/class/power_supply/battery/status'
E/BatteryService(762): Could not open '/sys/class/power_supply/battery/health'
E/BatteryService(762): Could not open '/sys/class/power_supply/battery/technology'
E/power (762): set_a_light failed to open /sys/class/leds/keyboard-backlight/brightness
I/SystemServer(762): Starting Alarm Manager.
I/SystemServer(762): Starting Sensor Service.
I/SystemServer(762): Starting Window Manager.
E/EventHub(762): could not add watch for /dev/input, Function not implemented
I/EventHub(762): New device: path=/dev/input/event1 name=s3c2410 TouchScreen id=0x10000 (of 0x1) index=1 fd=36 classes=0x4
E/EventHub(762): could not get driver version for /dev/input/mouse0, Not a typewriter
E/EventHub(762): could not get driver version for /dev/input/mice, Not a typewriter
I/EventHub(762): New device: path=/dev/input/event0 name=buttons id=0x10001 (of 0x2) index=2 fd=39 classes=0x1
I/EventHub(762): New keyboard: publicID=65537 device->id=65537 devname='buttons' propName='hw.keyboards.65537.devname' keylayout='/system/usr/keylayout/qwerty.kl'
I/KeyInputQueue(762): Device added: id=0x0, name=buttons, classes=1
I/KeyInputQueue(762): Device added: id=0x10000, name=null, classes=4
I/KeyInputQueue(762): X: min=0 max=1023 flat=0 fuzz=0
I/KeyInputQueue(762): Y: min=0 max=1023 flat=0 fuzz=0
I/KeyInputQueue(762): Pressure: min=0 max=1 flat=0 fuzz=0
I/KeyInputQueue(762): Size: unknown values
D/SensorManager(762): found sensor: null, handle=0
I/SystemServer(762): Starting Bluetooth Service.
I/SystemServer(762): Starting Status Bar Service.
I/SystemServer(762): Starting Clipboard Service.
I/SystemServer(762): Starting Input Method Service.
I/InputManagerService(762): Enabled input methods: com.example.android.softkeyboard/.SoftKeyboard
I/SystemServer(762): Starting Hardware Service.
I/SystemServer(762): Starting NetStat Service.
I/SystemServer(762): Starting Connectivity Service.
D/WifiService(762): WifiService starting up with Wi-Fi disabled
I/SystemServer(762): Starting Notification Manager.
I/SystemServer(762): Starting Mount Service.
D/MountListener(762): handleEvent ums_disconnected
D/MountListener(762): handleEvent ums_disabled
I/SystemServer(762): Starting DeviceStorageMonitor service
I/SystemServer(762): Starting Location Manager.
D/LocationManagerService(762): Constructed LocationManager Service
I/System.out(762): #### #### Setting locale to zh_CN
D/libhardware_legacy(762): no GPS hardware on this device
I/SystemServer(762): Starting Search Service.
I/SystemServer(762): Starting Checkin Service
W/SystemServer(762): Could not find com.google.android.server.checkin.CheckinService, trying fallback
I/SystemServer(762): Starting Wallpaper Service
D/WallpaperService(762): WallpaperService startup
I/SystemServer(762): Starting Audio Service
I/SystemServer(762): Starting HeadsetObserver
W/HeadsetObserver(762): This kernel does not have wired headset support
I/SystemServer(762): Starting Gadget Service
I/SystemServer(762): Starting OpdPrint Service
D/OpdPrintService(762): OpdPrintService startup
I/WindowManager(762): Input configuration changed: { scale=1.0 imsi=0/0 locale=zh_CN touch=3 key=1/1/2 nav=1 orien=1 }
I/WindowManager(762): Menu key state: 0
D/PowerManagerService(762): system ready!
D/ActivityManager(762): Start running!
I/Zygote(762): Process: zygote socket opened
D/dalvikvm(762): GC freed 4656 objects / 261448 bytes in 241ms
I/ActivityManager(762): Start proc com.android.phone for added application com.android.phone: pid=800 uid=1001 gids={3002, 3001, 3003}
I/ActivityManager(762): Starting activity: Intent { action=android.intent.action.MAIN categories={android.intent.category.HOME} flags=0x10000000 comp={com.android.launcher/com.android.launcher.Launcher} }
I/ActivityManager(762): Start proc android.process.acore for activity com.android.launcher/.Launcher: pid=807 uid=10006 gids={}
I/ActivityThread(807): Publishing provider com.android.launcher.settings: com.android.launcher.LauncherProvider
E/ApplicationContext(762): Couldn't create directory for SharedPreferences file shared_prefs/wallpaper-hints.xml
I/ActivityThread(800): Publishing provider sim: com.android.phone.SimProvider
W/ResourceType(762): No package identifier when getting value for resource number 0x00000000
W/StatusBar(762): Icon not found in <system>: 0
E/ActivityThread(800): Failed to find provider info for call_log
D/PhoneApp(800): [PhoneIntfMgr] publish: com.android.phone.PhoneInterfaceManager@436de138
D/StatusBar(762): updateResources
D/PhoneApp(800): Resetting audio state/mode: IDLE
D/dalvikvm(807): GC freed 1338 objects / 96488 bytes in 363ms
D/BT HSHFP(800): Starting BluetoothHeadsetService
D/PhoneApp(800): [CallNotifier] onMwiChanged(): false
D/PhoneApp(800): [CallNotifier] onCfiChanged(): false
V/ActivityThread(807): Resuming ActivityRecord{436b6998 token=android.os.BinderProxy@436b6428 {com.android.launcher/com.android.launcher.Launcher}} with isForward=false
I/ActivityManager(762): Displayed activity com.android.launcher/.Launcher: 2549 ms
I/SurfaceFlinger(762): Boot is finished (12547 ms)
I/WindowManager(762): Input configuration changed: { scale=1.0 imsi=0/0 locale=zh_CN touch=3 key=1/1/2 nav=1 orien=1 }
D/dalvikvm(762): GC freed 3208 objects / 141480 bytes in 388ms
I/ActivityManager(762): Start proc com.example.android.softkeyboard for service com.example.android.softkeyboard/.SoftKeyboard: pid=827 uid=10007 gids={}
W/InputManagerService(762): Starting input on non-focused client android.view.inputmethod.InputMethodManager$1@43793e70 (uid=1000 pid=762)
W/InputManagerService(762): Ignoring focus gain of: android.view.inputmethod.InputMethodManager$1@43793e70
I/ActivityManager(762): Start proc android.process.media for broadcast com.android.providers.media/.MediaScannerReceiver: pid=834 uid=10003 gids={1006}
I/ActivityThread(834): Publishing provider media: com.android.providers.media.MediaProvider
V/MediaProvider(834): Attached volume: internal
D/MediaScannerService(834): start scanning volume internal
D/MediaScanner(834):prescan time: 106ms
D/MediaScanner(834): scan time: 74ms
D/MediaScanner(834): postscan time: 0ms
D/MediaScanner(834):total time: 180ms
D/MediaScannerService(834): done scanning volume internal
I/ActivityManager(762): Stopping service: com.android.providers.media/.MediaScannerService

cole3	2010-07-05 21:32
楼主，我按你的方法修改了system/etc/shine/net.conf 后，就可以看见大钟了，一切运行正常，有图有真相……

clmcq	2010-07-23 15:42
我按照回楼主(yftljj) 的帖子修改了system/etc/shine/net.conf 后，就可以看见大钟了，一切运行正常。。。。。。楼主万岁

goldendays	2010-11-22 16:45
学习了

====

http://www.arm9home.net/simple/index.php?t3422.html

更多相关文章

随机推荐