You are viewing a plain text version of this content. The canonical link for it is here.
Posted to issues@cloudstack.apache.org by "Srikanteswararao Talluri (JIRA)" <ji...@apache.org> on 2013/04/02 07:17:14 UTC

[jira] [Created] (CLOUDSTACK-1878) ZWPS:NPE while enabling local storage while zone wide primary storage in the zone

Srikanteswararao Talluri created CLOUDSTACK-1878:
----------------------------------------------------

             Summary: ZWPS:NPE while  enabling local storage while zone wide primary storage in the zone 
                 Key: CLOUDSTACK-1878
                 URL: https://issues.apache.org/jira/browse/CLOUDSTACK-1878
             Project: CloudStack
          Issue Type: Bug
      Security Level: Public (Anyone can view this level - this is the default.)
    Affects Versions: 4.2.0
            Reporter: Srikanteswararao Talluri
            Priority: Blocker
             Fix For: 4.2.0


Steps to reproduce:
==============
Have a KVM zone with zone wide primary storage and cluster wide primary storage,

Modify the zone to use local storage

Now, host has a problem connecting to  existing storage pools(zone wide storage pools)

l) Sending Connect to listener: StoragePoolMonitor
2013-04-02 16:01:59,609 INFO  [network.security.SecurityGroupListener] (AgentConnectTaskPool-4:null) Received a host startup notification
2013-04-02 16:01:59,609 DEBUG [agent.manager.AgentManagerImpl] (AgentConnectTaskPool-4:null) Sending Connect to listener: StoragePoolMonitor
2013-04-02 16:01:59,640 DEBUG [storage.listener.StoragePoolMonitor] (AgentConnectTaskPool-3:null) Host 5 connected, sending down storage pool information ...
2013-04-02 16:01:59,650 DEBUG [agent.transport.Request] (AgentManager-Handler-1:null) Seq 5-159907842: Processing:  { Ans: , MgmtId: 7566222426160, via: 5, Ver: v1, Flags: 10, [{"Answer":{"result":true,"wait":0}}] }
2013-04-02 16:01:59,651 DEBUG [agent.transport.Request] (AgentManager-Handler-15:null) Seq 1-2100232194: Processing:  { Ans: , MgmtId: 7566222426160, via: 1, Ver: v1, Flags: 10, [{"Answer":{"result":true,"wait":0}}] }
2013-04-02 16:01:59,659 DEBUG [storage.listener.StoragePoolMonitor] (AgentConnectTaskPool-4:null) Host 1 connected, sending down storage pool information ...
2013-04-02 16:01:59,718 DEBUG [agent.transport.Request] (AgentManager-Handler-2:null) Seq 1-2100232194: Processing:  { Ans: , MgmtId: 7566222426160, via: 1, Ver: v1, Flags: 10, [{"Answer":{"result":true,"details":"","wait":0}}] }
2013-04-02 16:01:59,721 DEBUG [agent.transport.Request] (AgentManager-Handler-3:null) Seq 5-159907842: Processing:  { Ans: , MgmtId: 7566222426160, via: 5, Ver: v1, Flags: 10, [{"Answer":{"result":true,"details":"","wait":0}}] }
2013-04-02 16:01:59,723 DEBUG [cloud.storage.StorageManagerImpl] (AgentConnectTaskPool-4:null) Adding pool null to  host 1
2013-04-02 16:01:59,736 DEBUG [cloud.storage.StorageManagerImpl] (AgentConnectTaskPool-3:null) Adding pool null to  host 5
2013-04-02 16:01:59,744 DEBUG [agent.transport.Request] (AgentManager-Handler-4:null) Seq 4-590675969: Processing:  { Ans: , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 110, [{"Answer":{"result":true,"wait":0}}] }
2013-04-02 16:01:59,744 DEBUG [agent.transport.Request] (AgentConnectTaskPool-2:null) Seq 4-590675969: Received:  { Ans: , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 110, { Answer } }
2013-04-02 16:01:59,744 INFO  [cloud.consoleproxy.ConsoleProxyManagerImpl] (AgentConnectTaskPool-2:null) Successfully sent out command to start HTTP handling in console proxy agent
2013-04-02 16:01:59,753 DEBUG [agent.manager.AgentAttache] (AgentManager-Handler-4:null) Seq 4-590675969: No more commands found
2013-04-02 16:01:59,784 DEBUG [agent.transport.Request] (AgentConnectTaskPool-2:null) Seq 4-590675970: Sending  { Cmd , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 100111, [{"ReadyCommand":{"dcId":1,"hostId":4,"wait":0}}] }
2013-04-02 16:01:59,804 DEBUG [agent.transport.Request] (AgentConnectTaskPool-4:null) Seq 1-2100232195: Sending  { Cmd , MgmtId: 7566222426160, via: 1, Ver: v1, Flags: 100011, [{"ModifyStoragePoolCommand":{"add":true,"pool":{"id":1,"uuid":"130ba00a-323f-3b42-b738-0d9580fc21a0","host":"10.147.28.7","path":"/export/home/talluri/kvmp1","port":2049,"type":"NetworkFilesystem"},"localPath":"/mnt//130ba00a-323f-3b42-b738-0d9580fc21a0","wait":0}}] }
2013-04-02 16:01:59,806 DEBUG [agent.transport.Request] (AgentConnectTaskPool-3:null) Seq 5-159907843: Sending  { Cmd , MgmtId: 7566222426160, via: 5, Ver: v1, Flags: 100011, [{"ModifyStoragePoolCommand":{"add":true,"pool":{"id":3,"uuid":"763f7983-6cb8-3ccb-bc4d-30a36d015b21","host":"10.147.28.7","path":"/export/home/talluri/zwps","port":2049,"type":"NetworkFilesystem"},"localPath":"/mnt//763f7983-6cb8-3ccb-bc4d-30a36d015b21","wait":0}}] }
2013-04-02 16:01:59,835 DEBUG [agent.transport.Request] (AgentManager-Handler-6:null) Seq 4-590675970: Processing:  { Ans: , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 110, [{"ReadyAnswer":{"result":true,"wait":0}}] }
2013-04-02 16:01:59,835 DEBUG [agent.transport.Request] (AgentConnectTaskPool-2:null) Seq 4-590675970: Received:  { Ans: , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 110, { ReadyAnswer } }
2013-04-02 16:01:59,836 DEBUG [cloud.host.Status] (AgentConnectTaskPool-2:null) Transition:[Resource state = Enabled, Agent event = Ready, Host id = 4, name = v-2-VM]
2013-04-02 16:01:59,839 DEBUG [agent.manager.AgentAttache] (AgentManager-Handler-6:null) Seq 4-590675970: No more commands found
2013-04-02 16:01:59,857 DEBUG [agent.transport.Request] (AgentManager-Handler-5:null) Seq 5-159907843: Processing:  { Ans: , MgmtId: 7566222426160, via: 5, Ver: v1, Flags: 10, [{"ModifyStoragePoolAnswer":{"poolInfo":{"host":"10.147.28.7","localPath":"/mnt//763f7983-6cb8-3ccb-bc4d-30a36d015b21","hostPath":"/export/home/talluri/zwps","poolType":"NetworkFilesystem","capacityBytes":5902284816384,"availableBytes":2900170178560},"templateInfo":{},"result":true,"wait":0}}] }
2013-04-02 16:01:59,858 DEBUG [agent.transport.Request] (AgentConnectTaskPool-3:null) Seq 5-159907843: Received:  { Ans: , MgmtId: 7566222426160, via: 5, Ver: v1, Flags: 10, { ModifyStoragePoolAnswer } }
2013-04-02 16:01:59,862 DEBUG [cloud.host.Status] (AgentConnectTaskPool-2:null) Agent status update: [id = 4; name = v-2-VM; old status = Connecting; event = Ready; new status = Up; old update count = 1087; new update count = 1088]
2013-04-02 16:01:59,864 DEBUG [agent.transport.Request] (AgentManager-Handler-7:null) Seq 1-2100232195: Processing:  { Ans: , MgmtId: 7566222426160, via: 1, Ver: v1, Flags: 10, [{"ModifyStoragePoolAnswer":{"poolInfo":{"host":"10.147.28.7","localPath":"/mnt//130ba00a-323f-3b42-b738-0d9580fc21a0","hostPath":"/export/home/talluri/kvmp1","poolType":"NetworkFilesystem","capacityBytes":5902284816384,"availableBytes":2901470511104},"templateInfo":{},"result":true,"wait":0}}] }
2013-04-02 16:01:59,865 DEBUG [agent.transport.Request] (AgentConnectTaskPool-4:null) Seq 1-2100232195: Received:  { Ans: , MgmtId: 7566222426160, via: 1, Ver: v1, Flags: 10, { ModifyStoragePoolAnswer } }
2013-04-02 16:01:59,904 DEBUG [agent.transport.Request] (AgentConnectTaskPool-2:null) Seq 4-590675971: Sending  { Cmd , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 100111, [{"ReadyCommand":{"dcId":1,"hostId":4,"wait":0}}] }
2013-04-02 16:01:59,939 INFO  [datastore.provider.DefaultHostListener] (AgentConnectTaskPool-4:null) Connection established between org.apache.cloudstack.storage.datastore.DefaultPrimaryDataStore@3b5fea73 host + 1
2013-04-02 16:01:59,947 INFO  [datastore.provider.DefaultHostListener] (AgentConnectTaskPool-3:null) Connection established between org.apache.cloudstack.storage.datastore.DefaultPrimaryDataStore@1603ae07 host + 5
2013-04-02 16:01:59,965 DEBUG [agent.transport.Request] (AgentManager-Handler-8:null) Seq 4-590675971: Processing:  { Ans: , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 110, [{"ReadyAnswer":{"result":true,"wait":0}}] }
2013-04-02 16:01:59,965 DEBUG [agent.transport.Request] (AgentConnectTaskPool-2:null) Seq 4-590675971: Received:  { Ans: , MgmtId: 7566222426160, via: 4, Ver: v1, Flags: 110, { ReadyAnswer } }
2013-04-02 16:01:59,965 DEBUG [agent.manager.AgentAttache] (AgentManager-Handler-8:null) Seq 4-590675971: No more commands found
2013-04-02 16:01:59,968 WARN  [storage.listener.StoragePoolMonitor] (AgentConnectTaskPool-3:null) Unable to connect host 5 to pool Pool[3|NetworkFilesystem] due to java.lang.NullPointerException
java.lang.NullPointerException
        at com.cloud.storage.StorageManagerImpl.createCapacityEntry(StorageManagerImpl.java:1003)
        at com.cloud.storage.StorageManagerImpl.createCapacityEntry(StorageManagerImpl.java:1841)
        at com.cloud.storage.listener.StoragePoolMonitor.processConnect(StoragePoolMonitor.java:97)
        at com.cloud.agent.manager.AgentManagerImpl.notifyMonitorsOfConnection(AgentManagerImpl.java:611)
        at com.cloud.agent.manager.AgentManagerImpl.handleConnectedAgent(AgentManagerImpl.java:1111)
        at com.cloud.agent.manager.AgentManagerImpl.access$100(AgentManagerImpl.java:145)
        at com.cloud.agent.manager.AgentManagerImpl$HandleAgentConnectTask.run(AgentManagerImpl.java:1186)
        at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1110)
        at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:603)
        at java.lang.Thread.run(Thread.java:679)
2013-04-02 16:01:59,977 DEBUG [storage.listener.StoragePoolMonitor] (AgentConnectTaskPool-3:null) Host 5 connected, sending down storage pool information ...

mysql> select * from storage_pool\G;
*************************** 1. row ***************************
                   id: 1
                 name: p1
                 uuid: 130ba00a-323f-3b42-b738-0d9580fc21a0
            pool_type: NetworkFilesystem
                 port: 2049
       data_center_id: 1
               pod_id: 1
           cluster_id: 1
      available_bytes: 2901470511104
       capacity_bytes: 5902284816384
         host_address: 10.147.28.7
            user_info: NULL
                 path: /export/home/talluri/kvmp1
              created: 2013-04-01 14:18:28
              removed: NULL
          update_time: NULL
               status: Up
storage_provider_name: ancient primary data store provider
                scope: CLUSTER
*************************** 2. row ***************************
                   id: 2
                 name: Rack1Pod1Host25 Local Storage
                 uuid: 25916b04-0907-4f00-ab9b-d321ed802b60
            pool_type: Filesystem
                 port: 0
       data_center_id: 1
               pod_id: 1
           cluster_id: 1
      available_bytes: 47120719872
       capacity_bytes: 52844687360
         host_address: 10.147.40.25
            user_info: NULL
                 path: /var/lib/libvirt/images
              created: 2013-04-01 14:59:12
              removed: NULL
          update_time: NULL
               status: Up
storage_provider_name: ancient primary data store provider
                scope: HOST
*************************** 3. row ***************************
                   id: 3
                 name: zwps
                 uuid: 763f7983-6cb8-3ccb-bc4d-30a36d015b21
            pool_type: NetworkFilesystem
                 port: 2049
       data_center_id: 1
               pod_id: NULL
           cluster_id: NULL
      available_bytes: 2900202749952
       capacity_bytes: 5902284816384
         host_address: 10.147.28.7
            user_info: NULL
                 path: /export/home/talluri/zwps
              created: 2013-04-01 15:05:08
              removed: NULL
          update_time: NULL
               status: Up
storage_provider_name: ancient primary data store provider
                scope: ZONE
*************************** 4. row ***************************
                   id: 4
                 name: zwps1
                 uuid: 1fa482ac-85ac-3686-8375-aa596772b466
            pool_type: NetworkFilesystem
                 port: 2049
       data_center_id: 1
               pod_id: NULL
           cluster_id: NULL
      available_bytes: 2899951616000
       capacity_bytes: 5902284816384
         host_address: 10.147.28.7
            user_info: NULL
                 path: /export/home/talluri/zwps1
              created: 2013-04-01 15:10:45
              removed: NULL
          update_time: NULL
               status: Up
storage_provider_name: ancient primary data store provider
                scope: ZONE
*************************** 5. row ***************************
                   id: 5
                 name: Rack1Pod1Host22 Local Storage
                 uuid: a1cfc1c0-280f-4612-9edd-e8bb3d1049fb
            pool_type: Filesystem
                 port: 0
       data_center_id: 1
               pod_id: 1
           cluster_id: 2
      available_bytes: 47143645184
       capacity_bytes: 52844687360
         host_address: 10.147.40.22
            user_info: NULL
                 path: /var/lib/libvirt/images
              created: 2013-04-01 15:50:15
              removed: NULL
          update_time: NULL
               status: Up
storage_provider_name: ancient primary data store provider
                scope: HOST
*************************** 6. row ***************************
                   id: 6
                 name: zwps2
                 uuid: fec290f3-9361-3dbd-8a96-c861ad85973a
            pool_type: NetworkFilesystem
                 port: 2049
       data_center_id: 1
               pod_id: NULL
           cluster_id: NULL
      available_bytes: 2901470478336
       capacity_bytes: 5902284816384
         host_address: 10.147.28.7
            user_info: NULL
                 path: /export/home/talluri/zwps2
              created: 2013-04-01 18:20:54
              removed: NULL
          update_time: NULL
               status: Up
storage_provider_name: ancient primary data store provider
                scope: ZONE
6 rows in set (0.00 sec)

ERROR:
No query specified

mysql>




--
This message is automatically generated by JIRA.
If you think it was sent incorrectly, please contact your JIRA administrators
For more information on JIRA, see: http://www.atlassian.com/software/jira