logd[17275]: 2007/12/03_10:18:57 info: logd started with /etc/logd.cf.
logd[17277]: 2007/12/03_10:18:57 info: G_main_add_SignalHandler: Added signal handler for signal 15
logd[17275]: 2007/12/03_10:18:57 info: G_main_add_SignalHandler: Added signal handler for signal 15
heartbeat[17296]: 2007/12/03_10:18:57 info: Enabling logging daemon 
heartbeat[17296]: 2007/12/03_10:18:57 info: logfile and debug file are those specified in logd config file (default /etc/logd.cf)
heartbeat[17296]: 2007/12/03_10:18:57 info: **************************
heartbeat[17296]: 2007/12/03_10:18:57 info: Configuration validated. Starting heartbeat 2.1.3
heartbeat[17297]: 2007/12/03_10:18:57 info: heartbeat: version 2.1.3
heartbeat[17297]: 2007/12/03_10:18:58 info: Heartbeat generation: 61
heartbeat[17297]: 2007/12/03_10:18:58 info: Removing /var/run/heartbeat/rsctmp failed, recreating.
heartbeat[17297]: 2007/12/03_10:18:58 info: glib: UDP Broadcast heartbeat started on port 694 (694) interface eth2
heartbeat[17297]: 2007/12/03_10:18:58 info: glib: UDP Broadcast heartbeat closed on port 694 interface eth2 - Status: 1
heartbeat[17297]: 2007/12/03_10:18:58 info: G_main_add_TriggerHandler: Added signal manual handler
heartbeat[17297]: 2007/12/03_10:18:58 info: G_main_add_TriggerHandler: Added signal manual handler
heartbeat[17297]: 2007/12/03_10:18:58 info: G_main_add_SignalHandler: Added signal handler for signal 17
heartbeat[17297]: 2007/12/03_10:18:58 info: Local status now set to: 'up'
heartbeat[17297]: 2007/12/03_10:18:59 info: Link prec370d:eth2 up.
heartbeat[17297]: 2007/12/03_10:18:59 info: Status update for node prec370d: status up
heartbeat[17297]: 2007/12/03_10:18:59 info: Link prec370e:eth2 up.
heartbeat[17297]: 2007/12/03_10:18:59 debug: get_delnodelist: delnodelist= 
heartbeat[17297]: 2007/12/03_10:18:59 info: Comm_now_up(): updating status to active
heartbeat[17297]: 2007/12/03_10:18:59 info: Local status now set to: 'active'
heartbeat[17297]: 2007/12/03_10:18:59 info: Starting child client "/usr/lib64/heartbeat/ccm" (90,90)
heartbeat[17297]: 2007/12/03_10:18:59 info: Starting child client "/usr/lib64/heartbeat/cib" (90,90)
heartbeat[17297]: 2007/12/03_10:18:59 info: Starting child client "/usr/lib64/heartbeat/lrmd -r" (0,0)
heartbeat[17297]: 2007/12/03_10:18:59 info: Starting child client "/usr/lib64/heartbeat/stonithd" (0,0)
heartbeat[17297]: 2007/12/03_10:18:59 info: Starting child client "/usr/lib64/heartbeat/attrd" (90,90)
heartbeat[17297]: 2007/12/03_10:18:59 info: Starting child client "/usr/lib64/heartbeat/crmd" (90,90)
heartbeat[17297]: 2007/12/03_10:18:59 info: Starting child client "/usr/lib64/heartbeat/mgmtd -v" (0,0)
heartbeat[17305]: 2007/12/03_10:18:59 info: Starting "/usr/lib64/heartbeat/ccm" as uid 90  gid 90 (pid 17305)
heartbeat[17306]: 2007/12/03_10:18:59 info: Starting "/usr/lib64/heartbeat/cib" as uid 90  gid 90 (pid 17306)
heartbeat[17307]: 2007/12/03_10:18:59 info: Starting "/usr/lib64/heartbeat/lrmd -r" as uid 0  gid 0 (pid 17307)
heartbeat[17308]: 2007/12/03_10:18:59 info: Starting "/usr/lib64/heartbeat/stonithd" as uid 0  gid 0 (pid 17308)
heartbeat[17309]: 2007/12/03_10:18:59 info: Starting "/usr/lib64/heartbeat/attrd" as uid 90  gid 90 (pid 17309)
heartbeat[17310]: 2007/12/03_10:18:59 info: Starting "/usr/lib64/heartbeat/crmd" as uid 90  gid 90 (pid 17310)
heartbeat[17311]: 2007/12/03_10:18:59 info: Starting "/usr/lib64/heartbeat/mgmtd -v" as uid 0  gid 0 (pid 17311)
mgmtd[17311]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 15
mgmtd[17311]: 2007/12/03_10:18:59 debug: Enabling coredumps
cib[17306]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 15
cib[17306]: 2007/12/03_10:18:59 info: G_main_add_TriggerHandler: Added signal manual handler
cib[17306]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 17
cib[17306]: 2007/12/03_10:18:59 info: main: Retrieval of a per-action CIB: disabled
mgmtd[17311]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 10
mgmtd[17311]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 12
cib[17306]: 2007/12/03_10:18:59 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17306]: 2007/12/03_10:18:59 WARN: retrieveCib: Cluster configuration not found: /var/lib/heartbeat/crm/cib.xml
mgmtd[17311]: 2007/12/03_10:18:59 WARN: lrm_signon: can not initiate connection
ccm[17305]: 2007/12/03_10:18:59 info: Hostname: prec370e
cib[17306]: 2007/12/03_10:18:59 WARN: readCibXmlFile: Primary configuration corrupt or unusable, trying backup...
mgmtd[17311]: 2007/12/03_10:18:59 info: login to lrm: 0, ret:0
cib[17306]: 2007/12/03_10:18:59 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
cib[17306]: 2007/12/03_10:18:59 WARN: retrieveCib: Cluster configuration not found: /var/lib/heartbeat/crm/cib.xml.last
cib[17306]: 2007/12/03_10:18:59 WARN: readCibXmlFile: Continuing with an empty configuration.
cib[17306]: 2007/12/03_10:18:59 WARN: readCibXmlFile: No value for admin_epoch was specified in the configuration.
cib[17306]: 2007/12/03_10:18:59 WARN: readCibXmlFile: The reccomended course of action is to shutdown, run crm_verify and fix any errors it reports.
cib[17306]: 2007/12/03_10:18:59 WARN: readCibXmlFile: We will default to zero and continue but may get confused about which configuration to use if multiple nodes are powered up at the same time.
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk] <cib generated="true" admin_epoch="0" epoch="0" num_updates="0" have_quorum="false">
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk]   <configuration>
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk]     <crm_config/>
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk]     <nodes/>
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk]     <resources/>
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk]     <constraints/>
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk]   </configuration>
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk]   <status/>
cib[17306]: 2007/12/03_10:18:59 info: log_data_element: readCibXmlFile: [on-disk] </cib>
cib[17306]: 2007/12/03_10:18:59 notice: readCibXmlFile: Enabling DTD validation on the existing (sane) configuration
cib[17306]: 2007/12/03_10:18:59 info: startCib: CIB Initialization completed successfully
cib[17306]: 2007/12/03_10:18:59 info: cib_register_ha: Signing in with Heartbeat
cib[17306]: 2007/12/03_10:18:59 info: cib_register_ha: FSA Hostname: prec370e
cib[17306]: 2007/12/03_10:18:59 info: ccm_connect: Registering with CCM...
cib[17306]: 2007/12/03_10:18:59 WARN: ccm_connect: CCM Activation failed
cib[17306]: 2007/12/03_10:18:59 WARN: ccm_connect: CCM Connection failed 1 times (30 max)
crmd[17310]: 2007/12/03_10:18:59 info: main: CRM Hg Version: f153a9be0bdf tip

crmd[17310]: 2007/12/03_10:18:59 info: crmd_init: Starting crmd
crmd[17310]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 15
crmd[17310]: 2007/12/03_10:18:59 info: G_main_add_TriggerHandler: Added signal manual handler
crmd[17310]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 17
stonithd[17308]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 10
stonithd[17308]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 12
stonithd[17308]: 2007/12/03_10:18:59 info: Signing in with heartbeat.
lrmd[17307]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 15
stonithd[17308]: 2007/12/03_10:18:59 notice: /usr/lib64/heartbeat/stonithd start up successfully.
stonithd[17308]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 17
lrmd[17307]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 17
lrmd[17307]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 10
lrmd[17307]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 12
lrmd[17307]: 2007/12/03_10:18:59 info: Started.
attrd[17309]: 2007/12/03_10:18:59 info: G_main_add_SignalHandler: Added signal handler for signal 15
attrd[17309]: 2007/12/03_10:18:59 info: register_with_ha: Hostname: prec370e
heartbeat[17297]: 2007/12/03_10:19:00 info: Status update for node prec370d: status active
attrd[17309]: 2007/12/03_10:19:00 info: register_with_ha: UUID: 9d9ca527-cea9-470c-9e03-e49fe5630bba
mgmtd[17311]: 2007/12/03_10:19:00 info: init_crm
cib[17306]: 2007/12/03_10:19:02 info: ccm_connect: Registering with CCM...
cib[17306]: 2007/12/03_10:19:02 WARN: ccm_connect: CCM Activation failed
cib[17306]: 2007/12/03_10:19:02 WARN: ccm_connect: CCM Connection failed 2 times (30 max)
ccm[17305]: 2007/12/03_10:19:03 info: G_main_add_SignalHandler: Added signal handler for signal 15
heartbeat[17297]: 2007/12/03_10:19:03 WARN: 1 lost packet(s) for [prec370d] [14:16]
heartbeat[17297]: 2007/12/03_10:19:03 info: No pkts missing from prec370d!
heartbeat[17297]: 2007/12/03_10:19:04 WARN: 1 lost packet(s) for [prec370d] [19:21]
heartbeat[17297]: 2007/12/03_10:19:04 info: No pkts missing from prec370d!
ccm[17305]: 2007/12/03_10:19:05 debug: quorum plugin: majority
ccm[17305]: 2007/12/03_10:19:05 debug: cluster:linux-ha, member_count=1, member_quorum_votes=100
ccm[17305]: 2007/12/03_10:19:05 debug: total_node_count=2, total_quorum_votes=200
ccm[17305]: 2007/12/03_10:19:05 debug: quorum plugin: twonodes
ccm[17305]: 2007/12/03_10:19:05 debug: cluster:linux-ha, member_count=1, member_quorum_votes=100
ccm[17305]: 2007/12/03_10:19:05 debug: total_node_count=2, total_quorum_votes=200
ccm[17305]: 2007/12/03_10:19:05 info: Break tie for 2 nodes cluster
cib[17306]: 2007/12/03_10:19:05 info: ccm_connect: Registering with CCM...
ccm[17305]: 2007/12/03_10:19:06 debug: quorum plugin: majority
ccm[17305]: 2007/12/03_10:19:06 debug: cluster:linux-ha, member_count=2, member_quorum_votes=200
ccm[17305]: 2007/12/03_10:19:06 debug: total_node_count=2, total_quorum_votes=200
cib[17306]: 2007/12/03_10:19:06 info: cib_init: Starting cib mainloop
cib[17306]: 2007/12/03_10:19:06 info: mem_handle_event: Got an event OC_EV_MS_NEW_MEMBERSHIP from ccm
cib[17306]: 2007/12/03_10:19:06 info: mem_handle_event: instance=1, nodes=1, new=1, lost=0, n_idx=0, new_idx=0, old_idx=3
cib[17306]: 2007/12/03_10:19:06 info: cib_ccm_msg_callback: PEER: prec370e
cib[17306]: 2007/12/03_10:19:06 info: mem_handle_event: Got an event OC_EV_MS_INVALID from ccm
cib[17306]: 2007/12/03_10:19:06 info: mem_handle_event: no mbr_track info
cib[17306]: 2007/12/03_10:19:06 info: mem_handle_event: Got an event OC_EV_MS_NEW_MEMBERSHIP from ccm
cib[17306]: 2007/12/03_10:19:06 info: mem_handle_event: instance=2, nodes=2, new=1, lost=0, n_idx=0, new_idx=2, old_idx=4
cib[17306]: 2007/12/03_10:19:06 info: cib_ccm_msg_callback: PEER: prec370e
cib[17306]: 2007/12/03_10:19:06 info: cib_ccm_msg_callback: PEER: prec370d
crmd[17310]: 2007/12/03_10:19:06 info: do_cib_control: CIB connection established
crmd[17310]: 2007/12/03_10:19:06 info: register_with_ha: Hostname: prec370e
cib[17306]: 2007/12/03_10:19:06 info: cib_client_status_callback: Status update: Client prec370e/cib now has status [join]
cib[17306]: 2007/12/03_10:19:06 info: cib_null_callback: Setting cib_refresh_notify callbacks for crmd: on
cib[17306]: 2007/12/03_10:19:06 info: cib_null_callback: Setting cib_diff_notify callbacks for mgmtd: on
cib[17306]: 2007/12/03_10:19:06 info: cib_client_status_callback: Status update: Client prec370d/cib now has status [join]
cib[17306]: 2007/12/03_10:19:06 info: cib_client_status_callback: Status update: Client prec370e/cib now has status [online]
cib[17314]: 2007/12/03_10:19:06 info: write_cib_contents: Wrote version 0.0.0 of the CIB to disk (digest: b52b60576a8aa95f60b1461b7038c0c7)
cib[17314]: 2007/12/03_10:19:06 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17306]: 2007/12/03_10:19:06 info: cib_client_status_callback: Status update: Client prec370d/cib now has status [online]
crmd[17310]: 2007/12/03_10:19:06 info: register_with_ha: UUID: 9d9ca527-cea9-470c-9e03-e49fe5630bba
mgmtd[17311]: 2007/12/03_10:19:07 debug: main: run the loop...
mgmtd[17311]: 2007/12/03_10:19:07 info: Started.
crmd[17310]: 2007/12/03_10:19:07 info: populate_cib_nodes: Requesting the list of configured nodes
crmd[17310]: 2007/12/03_10:19:08 notice: populate_cib_nodes: Node: prec370e (uuid: 9d9ca527-cea9-470c-9e03-e49fe5630bba)
crmd[17310]: 2007/12/03_10:19:08 notice: populate_cib_nodes: Node: prec370d (uuid: 6a42b4b7-7a31-4ae7-b241-ed4ad4267ec6)
crmd[17310]: 2007/12/03_10:19:08 info: do_ha_control: Connected to Heartbeat
crmd[17310]: 2007/12/03_10:19:08 info: do_ccm_control: CCM connection established... waiting for first callback
crmd[17310]: 2007/12/03_10:19:08 info: do_started: Delaying start, CCM (0000000000100000) not connected
crmd[17310]: 2007/12/03_10:19:08 info: crmd_init: Starting crmd's mainloop
crmd[17310]: 2007/12/03_10:19:08 notice: crmd_client_status_callback: Status update: Client prec370e/crmd now has status [online]
cib[17315]: 2007/12/03_10:19:08 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17315]: 2007/12/03_10:19:08 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17315]: 2007/12/03_10:19:08 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
cib[17315]: 2007/12/03_10:19:08 info: write_cib_contents: Wrote version 0.0.0 of the CIB to disk (digest: d5edc0a538b450fcf83431596f640631)
cib[17315]: 2007/12/03_10:19:08 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17315]: 2007/12/03_10:19:08 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
crmd[17310]: 2007/12/03_10:19:09 notice: crmd_client_status_callback: Status update: Client prec370e/crmd now has status [online]
crmd[17310]: 2007/12/03_10:19:09 notice: crmd_client_status_callback: Status update: Client prec370d/crmd now has status [online]
crmd[17310]: 2007/12/03_10:19:10 info: mem_handle_event: Got an event OC_EV_MS_NEW_MEMBERSHIP from ccm
crmd[17310]: 2007/12/03_10:19:10 info: mem_handle_event: instance=2, nodes=2, new=2, lost=0, n_idx=0, new_idx=0, old_idx=4
crmd[17310]: 2007/12/03_10:19:10 info: crmd_ccm_msg_callback: Quorum (re)attained after event=NEW MEMBERSHIP (id=2)
crmd[17310]: 2007/12/03_10:19:10 info: ccm_event_detail: NEW MEMBERSHIP: trans=2, nodes=2, new=2, lost=0 n_idx=0, new_idx=0, old_idx=4
crmd[17310]: 2007/12/03_10:19:10 info: ccm_event_detail: 	CURRENT: prec370e [nodeid=1, born=1]
crmd[17310]: 2007/12/03_10:19:10 info: ccm_event_detail: 	CURRENT: prec370d [nodeid=0, born=2]
crmd[17310]: 2007/12/03_10:19:10 info: ccm_event_detail: 	NEW:     prec370e [nodeid=1, born=1]
crmd[17310]: 2007/12/03_10:19:10 info: ccm_event_detail: 	NEW:     prec370d [nodeid=0, born=2]
crmd[17310]: 2007/12/03_10:19:10 info: do_started: Delaying start, Config not read (0000000000000040)
crmd[17310]: 2007/12/03_10:19:10 info: do_started: The local CRM is operational
crmd[17310]: 2007/12/03_10:19:10 info: do_state_transition: State transition S_STARTING -> S_PENDING [ input=I_PENDING cause=C_FSA_INTERNAL origin=do_started ]
attrd[17309]: 2007/12/03_10:19:11 info: main: Starting mainloop...
crmd[17310]: 2007/12/03_10:19:38 info: do_election_count_vote: Election check: vote from prec370d
crmd[17310]: 2007/12/03_10:19:41 info: crm_timer_popped: Election Trigger (I_DC_TIMEOUT) just popped!
crmd[17310]: 2007/12/03_10:19:41 WARN: do_log: [[FSA]] Input I_DC_TIMEOUT from crm_timer_popped() received in state (S_PENDING)
crmd[17310]: 2007/12/03_10:19:41 info: do_state_transition: State transition S_PENDING -> S_ELECTION [ input=I_DC_TIMEOUT cause=C_TIMER_POPPED origin=crm_timer_popped ]
crmd[17310]: 2007/12/03_10:19:41 info: do_election_count_vote: Updated voted hash for prec370e to vote
crmd[17310]: 2007/12/03_10:19:41 info: do_election_count_vote: Election ignore: our vote (prec370e)
crmd[17310]: 2007/12/03_10:19:41 info: do_election_check: Still waiting on 1 non-votes (2 total)
crmd[17310]: 2007/12/03_10:19:42 info: do_election_count_vote: Updated voted hash for prec370d to no-vote
crmd[17310]: 2007/12/03_10:19:42 info: do_election_count_vote: Election ignore: no-vote from prec370d
crmd[17310]: 2007/12/03_10:19:42 info: do_state_transition: State transition S_ELECTION -> S_INTEGRATION [ input=I_ELECTION_DC cause=C_FSA_INTERNAL origin=do_election_check ]
crmd[17310]: 2007/12/03_10:19:42 info: start_subsystem: Starting sub-system "tengine"
crmd[17310]: 2007/12/03_10:19:42 info: start_subsystem: Starting sub-system "pengine"
crmd[17310]: 2007/12/03_10:19:42 info: do_dc_takeover: Taking over DC status for this partition
cib[17306]: 2007/12/03_10:19:42 info: cib_process_readwrite: We are now in R/W mode
cib[17306]: 2007/12/03_10:19:42 info: revision_check: Updating CIB revision to 2.0
crmd[17310]: 2007/12/03_10:19:42 info: join_make_offer: Making join offers based on membership 2
crmd[17310]: 2007/12/03_10:19:42 info: do_dc_join_offer_all: join-1: Waiting on 2 outstanding join acks
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: - <cib epoch="0"/>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: + <cib epoch="1">
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +   <configuration>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +     <crm_config>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +       <cluster_property_set id="cib-bootstrap-options">
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +         <attributes>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +           <nvpair id="cib-bootstrap-options-dc-version" name="dc-version" value="2.1.3-f153a9be0bdf tip"/>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +         </attributes>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +       </cluster_property_set>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +     </crm_config>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: +   </configuration>
cib[17306]: 2007/12/03_10:19:42 info: log_data_element: cib:diff: + </cib>
cib[17321]: 2007/12/03_10:19:42 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17321]: 2007/12/03_10:19:42 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17321]: 2007/12/03_10:19:42 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
pengine[17320]: 2007/12/03_10:19:42 info: G_main_add_SignalHandler: Added signal handler for signal 15
tengine[17319]: 2007/12/03_10:19:42 info: G_main_add_SignalHandler: Added signal handler for signal 15
tengine[17319]: 2007/12/03_10:19:42 info: G_main_add_TriggerHandler: Added signal manual handler
tengine[17319]: 2007/12/03_10:19:42 info: G_main_add_TriggerHandler: Added signal manual handler
pengine[17320]: 2007/12/03_10:19:42 info: pe_init: Starting pengine
cib[17321]: 2007/12/03_10:19:42 info: write_cib_contents: Wrote version 0.1.1 of the CIB to disk (digest: c88b999c7729e9c191d5845ce17d5a65)
cib[17306]: 2007/12/03_10:19:42 info: cib_null_callback: Setting cib_diff_notify callbacks for tengine: on
tengine[17319]: 2007/12/03_10:19:42 info: te_init: Registering TE UUID: f782d1f4-b91f-4232-8898-3d9be0a82683
tengine[17319]: 2007/12/03_10:19:42 info: set_graph_functions: Setting custom graph functions
tengine[17319]: 2007/12/03_10:19:42 info: unpack_graph: Unpacked transition -1: 0 actions in 0 synapses
tengine[17319]: 2007/12/03_10:19:42 info: te_init: Starting tengine
tengine[17319]: 2007/12/03_10:19:42 info: te_connect_stonith: Attempting connection to fencing daemon...
cib[17321]: 2007/12/03_10:19:42 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17321]: 2007/12/03_10:19:42 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
crmd[17310]: 2007/12/03_10:19:42 info: update_dc: Set DC to prec370e (2.0)
crmd[17310]: 2007/12/03_10:19:43 info: do_state_transition: State transition S_INTEGRATION -> S_FINALIZE_JOIN [ input=I_INTEGRATED cause=C_FSA_INTERNAL origin=check_join_state ]
crmd[17310]: 2007/12/03_10:19:43 info: do_state_transition: All 2 cluster nodes responded to the join offer.
crmd[17310]: 2007/12/03_10:19:43 info: update_attrd: Connecting to attrd...
attrd[17309]: 2007/12/03_10:19:43 info: attrd_local_callback: Sending full refresh
cib[17306]: 2007/12/03_10:19:43 info: sync_our_cib: Syncing CIB to prec370d
cib[17306]: 2007/12/03_10:19:43 info: sync_our_cib: Syncing CIB to all peers
tengine[17319]: 2007/12/03_10:19:43 info: te_connect_stonith: Connected
crmd[17310]: 2007/12/03_10:19:43 info: update_dc: Set DC to prec370e (2.0)
crmd[17310]: 2007/12/03_10:19:43 info: do_dc_join_ack: join-1: Updating node state to member for prec370e
crmd[17310]: 2007/12/03_10:19:44 info: do_dc_join_ack: join-1: Updating node state to member for prec370d
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: State transition S_FINALIZE_JOIN -> S_POLICY_ENGINE [ input=I_FINALIZED cause=C_FSA_INTERNAL origin=check_join_state ]
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: All 2 cluster nodes are eligible to run resources.
tengine[17319]: 2007/12/03_10:19:44 info: update_abort_priority: Abort priority upgraded to 1000000
tengine[17319]: 2007/12/03_10:19:44 info: update_abort_priority: 'DC Takeover' abort superceeded
pengine[17320]: 2007/12/03_10:19:44 info: determine_online_status: Node prec370e is online
pengine[17320]: 2007/12/03_10:19:44 info: determine_online_status: Node prec370d is online
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: State transition S_POLICY_ENGINE -> S_TRANSITION_ENGINE [ input=I_PE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
tengine[17319]: 2007/12/03_10:19:44 info: unpack_graph: Unpacked transition 0: 2 actions in 2 synapses
tengine[17319]: 2007/12/03_10:19:44 info: send_rsc_command: Initiating action 2: probe_complete on prec370e
tengine[17319]: 2007/12/03_10:19:44 info: send_rsc_command: Initiating action 3: probe_complete on prec370d
tengine[17319]: 2007/12/03_10:19:44 info: run_graph: Transition 0: (Complete=2, Pending=0, Fired=0, Skipped=0, Incomplete=0)
tengine[17319]: 2007/12/03_10:19:44 info: notify_crmd: Transition 0 status: te_complete - <null>
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: State transition S_TRANSITION_ENGINE -> S_IDLE [ input=I_TE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
pengine[17320]: 2007/12/03_10:19:44 info: process_pe_message: Transition 0: PEngine Input stored in: /var/lib/heartbeat/pengine/pe-input-0.bz2
tengine[17319]: 2007/12/03_10:19:44 info: extract_event: Aborting on transient_attributes changes for 9d9ca527-cea9-470c-9e03-e49fe5630bba
tengine[17319]: 2007/12/03_10:19:44 info: update_abort_priority: Abort priority upgraded to 1000000
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: State transition S_IDLE -> S_POLICY_ENGINE [ input=I_PE_CALC cause=C_IPC_MESSAGE origin=route_message ]
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: All 2 cluster nodes are eligible to run resources.
pengine[17320]: 2007/12/03_10:19:44 info: determine_online_status: Node prec370e is online
pengine[17320]: 2007/12/03_10:19:44 info: determine_online_status: Node prec370d is online
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: State transition S_POLICY_ENGINE -> S_TRANSITION_ENGINE [ input=I_PE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
tengine[17319]: 2007/12/03_10:19:44 info: unpack_graph: Unpacked transition 1: 1 actions in 1 synapses
tengine[17319]: 2007/12/03_10:19:44 info: send_rsc_command: Initiating action 3: probe_complete on prec370d
crmd[17310]: 2007/12/03_10:19:44 info: do_state_transition: State transition S_TRANSITION_ENGINE -> S_IDLE [ input=I_TE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
tengine[17319]: 2007/12/03_10:19:44 info: run_graph: Transition 1: (Complete=1, Pending=0, Fired=0, Skipped=0, Incomplete=0)
tengine[17319]: 2007/12/03_10:19:44 info: notify_crmd: Transition 1 status: te_complete - <null>
pengine[17320]: 2007/12/03_10:19:44 info: process_pe_message: Transition 1: PEngine Input stored in: /var/lib/heartbeat/pengine/pe-input-1.bz2
tengine[17319]: 2007/12/03_10:19:45 info: extract_event: Aborting on transient_attributes changes for 6a42b4b7-7a31-4ae7-b241-ed4ad4267ec6
tengine[17319]: 2007/12/03_10:19:45 info: update_abort_priority: Abort priority upgraded to 1000000
crmd[17310]: 2007/12/03_10:19:45 info: do_state_transition: State transition S_IDLE -> S_POLICY_ENGINE [ input=I_PE_CALC cause=C_IPC_MESSAGE origin=route_message ]
crmd[17310]: 2007/12/03_10:19:45 info: do_state_transition: All 2 cluster nodes are eligible to run resources.
pengine[17320]: 2007/12/03_10:19:45 info: determine_online_status: Node prec370e is online
pengine[17320]: 2007/12/03_10:19:45 info: determine_online_status: Node prec370d is online
crmd[17310]: 2007/12/03_10:19:45 info: do_state_transition: State transition S_POLICY_ENGINE -> S_TRANSITION_ENGINE [ input=I_PE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
tengine[17319]: 2007/12/03_10:19:45 info: unpack_graph: Unpacked transition 2: 0 actions in 0 synapses
crmd[17310]: 2007/12/03_10:19:45 info: do_state_transition: State transition S_TRANSITION_ENGINE -> S_IDLE [ input=I_TE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
tengine[17319]: 2007/12/03_10:19:45 info: run_graph: Transition 2: (Complete=0, Pending=0, Fired=0, Skipped=0, Incomplete=0)
tengine[17319]: 2007/12/03_10:19:45 info: notify_crmd: Transition 2 status: te_complete - <null>
pengine[17320]: 2007/12/03_10:19:45 info: process_pe_message: Transition 2: PEngine Input stored in: /var/lib/heartbeat/pengine/pe-input-2.bz2
tengine[17319]: 2007/12/03_10:20:13 info: update_abort_priority: Abort priority upgraded to 1000000
crmd[17310]: 2007/12/03_10:20:13 info: do_state_transition: State transition S_IDLE -> S_POLICY_ENGINE [ input=I_PE_CALC cause=C_IPC_MESSAGE origin=route_message ]
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: - <cib epoch="1" num_updates="9" cib_feature_revision="2.0"/>
crmd[17310]: 2007/12/03_10:20:13 info: do_state_transition: All 2 cluster nodes are eligible to run resources.
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: + <cib epoch="2" num_updates="1" cib_feature_revision="1.3">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +   <configuration>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +     <crm_config>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       <cluster_property_set id="idCluseterPropertySet">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         <attributes>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="symmetric-cluster" name="symmetric-cluster" value="true"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="no-quorum-policy" name="no-quorum-policy" value="ignore"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="stonith-enabled" name="stonith-enabled" value="false"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="short-resource-names" name="short_resource_names" value="true"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="is-managed-default" name="is-managed-default" value="true"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="transition-idle-timeout" name="transition-idle-timeout" value="120s"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="default-resource-stickiness" name="default-resource-stickiness" value="INFINITY"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="stop-orphan-resources" name="stop-orphan-resources" value="true"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="stop-orphan-actions" name="stop-orphan-actions" value="true"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="remove-after-stop" name="remove-after-stop" value="false"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="default-resource-failure-stickiness" name="default-resource-failure-stickiness" value="-INFINITY"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="stonith-action" name="stonith-action" value="reboot"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="default-action-timeout" name="default-action-timeout" value="120s"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="dc_deadtime" name="dc_deadtime" value="10s"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="cluster_recheck_interval" name="cluster_recheck_interval" value="0"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="election_timeout" name="election_timeout" value="2min"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="shutdown_escalation" name="shutdown_escalation" value="20min"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="crmd-integration-timeout" name="crmd-integration-timeout" value="3min"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="crmd-finalization-timeout" name="crmd-finalization-timeout" value="10min"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="cluster-delay" name="cluster-delay" value="60s"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="pe-error-series-max" name="pe-error-series-max" value="-1"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="pe-warn-series-max" name="pe-warn-series-max" value="-1"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="pe-input-series-max" name="pe-input-series-max" value="-1"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <nvpair id="startup-fencing" name="startup-fencing" value="true"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         </attributes>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       </cluster_property_set>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +     </crm_config>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +     <resources>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       <group id="grpDummy">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         <primitive id="prmDummy" class="ocf" type="Dummy" provider="heartbeat">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <operations>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +             <op id="opDummyStart" name="start" timeout="60s" on_fail="fence"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +             <op id="opDummyMonitor" name="monitor" interval="10s" timeout="10s" on_fail="fence"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +             <op id="opDummyStop" name="stop" timeout="60s" on_fail="fence"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           </operations>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <instance_attributes id="atrDummy">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +             <attributes>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +               <nvpair id="atrDummy1" name="delay" value="1"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +               <nvpair id="atrDummy2" name="state" value="/var/run/heartbeat/rsctmp/Dummy.state"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +             </attributes>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           </instance_attributes>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         </primitive>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       </group>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +     </resources>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +     <constraints>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       <rsc_location id="rlcDummy" rsc="grpDummy">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         <rule score="300" id="rulNode1">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <expression value="prec370d" attribute="#uname" operation="eq" id="expNode1"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         </rule>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         <rule score="200" id="rulNode2">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <expression value="prec370e" attribute="#uname" operation="eq" id="expNode2"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         </rule>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       </rsc_location>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       <rsc_location id="ping:disconn" rsc="grpDummy">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         <rule id="ping1:disconn:rule" score="-INFINITY" boolean_op="and">
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <expression id="ping1:disconn:expr:defined" attribute="default_ping_set" operation="defined"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +           <expression id="ping1:disconn:expr:positive" attribute="default_ping_set" operation="lt" value="100"/>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +         </rule>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +       </rsc_location>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +     </constraints>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: +   </configuration>
cib[17306]: 2007/12/03_10:20:13 info: log_data_element: cib:diff: + </cib>
cib[17323]: 2007/12/03_10:20:13 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
crmd[17310]: 2007/12/03_10:20:13 info: do_state_transition: State transition S_POLICY_ENGINE -> S_TRANSITION_ENGINE [ input=I_PE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
pengine[17320]: 2007/12/03_10:20:13 notice: unpack_config: On loss of CCM Quorum: Ignore
cib[17323]: 2007/12/03_10:20:13 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
pengine[17320]: 2007/12/03_10:20:13 info: determine_online_status: Node prec370e is online
cib[17323]: 2007/12/03_10:20:13 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
pengine[17320]: 2007/12/03_10:20:13 info: determine_online_status: Node prec370d is online
pengine[17320]: 2007/12/03_10:20:13 notice: group_print: Resource Group: grpDummy
pengine[17320]: 2007/12/03_10:20:13 notice: native_print:     prmDummy	(heartbeat::ocf:Dummy):	Stopped 
pengine[17320]: 2007/12/03_10:20:13 ERROR: unpack_operation: Specifying on_fail=fence and stonith-enabled=false makes no sense
pengine[17320]: 2007/12/03_10:20:13 notice: StartRsc:  prec370d	Start prmDummy
pengine[17320]: 2007/12/03_10:20:13 ERROR: unpack_operation: Specifying on_fail=fence and stonith-enabled=false makes no sense
pengine[17320]: 2007/12/03_10:20:13 notice: RecurringOp: prec370d	   prmDummy_monitor_10000
pengine[17320]: 2007/12/03_10:20:13 ERROR: unpack_operation: Specifying on_fail=fence and stonith-enabled=false makes no sense
tengine[17319]: 2007/12/03_10:20:13 info: unpack_graph: Unpacked transition 3: 9 actions in 9 synapses
tengine[17319]: 2007/12/03_10:20:13 info: send_rsc_command: Initiating action 3: prmDummy_monitor_0 on prec370e
tengine[17319]: 2007/12/03_10:20:13 info: send_rsc_command: Initiating action 5: prmDummy_monitor_0 on prec370d
crmd[17310]: 2007/12/03_10:20:13 info: do_lrm_rsc_op: Performing op=prmDummy_monitor_0 key=3:3:f782d1f4-b91f-4232-8898-3d9be0a82683)
lrmd[17307]: 2007/12/03_10:20:13 info: rsc:prmDummy: monitor
pengine[17320]: 2007/12/03_10:20:13 info: process_pe_message: Transition 3: PEngine Input stored in: /var/lib/heartbeat/pengine/pe-input-3.bz2
pengine[17320]: 2007/12/03_10:20:13 info: process_pe_message: Configuration ERRORs found during PE processing.  Please run "crm_verify -L" to identify issues.
cib[17323]: 2007/12/03_10:20:13 info: write_cib_contents: Wrote version 0.2.1 of the CIB to disk (digest: cb24adf09480e65860c3909f71499293)
cib[17323]: 2007/12/03_10:20:13 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17323]: 2007/12/03_10:20:13 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
Dummy[17324][17330]: 2007/12/03_10:20:13 DEBUG: prmDummy monitor : 7
crmd[17310]: 2007/12/03_10:20:13 info: process_lrm_event: LRM operation prmDummy_monitor_0 (call=2, rc=7) complete 
tengine[17319]: 2007/12/03_10:20:13 info: match_graph_event: Action prmDummy_monitor_0 (3) confirmed on prec370e (rc=0)
tengine[17319]: 2007/12/03_10:20:13 info: send_rsc_command: Initiating action 2: probe_complete on prec370e
tengine[17319]: 2007/12/03_10:20:14 info: match_graph_event: Action prmDummy_monitor_0 (5) confirmed on prec370d (rc=0)
tengine[17319]: 2007/12/03_10:20:14 info: send_rsc_command: Initiating action 4: probe_complete on prec370d
tengine[17319]: 2007/12/03_10:20:14 info: te_pseudo_action: Pseudo action 1 fired and confirmed
tengine[17319]: 2007/12/03_10:20:14 info: te_pseudo_action: Pseudo action 9 fired and confirmed
tengine[17319]: 2007/12/03_10:20:14 info: send_rsc_command: Initiating action 7: prmDummy_start_0 on prec370d
tengine[17319]: 2007/12/03_10:20:15 info: match_graph_event: Action prmDummy_start_0 (7) confirmed on prec370d (rc=0)
tengine[17319]: 2007/12/03_10:20:15 info: te_pseudo_action: Pseudo action 10 fired and confirmed
tengine[17319]: 2007/12/03_10:20:15 info: send_rsc_command: Initiating action 8: prmDummy_monitor_10000 on prec370d
crmd[17310]: 2007/12/03_10:20:16 info: do_state_transition: State transition S_TRANSITION_ENGINE -> S_IDLE [ input=I_TE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
tengine[17319]: 2007/12/03_10:20:16 info: match_graph_event: Action prmDummy_monitor_10000 (8) confirmed on prec370d (rc=0)
tengine[17319]: 2007/12/03_10:20:16 info: run_graph: Transition 3: (Complete=9, Pending=0, Fired=0, Skipped=0, Incomplete=0)
tengine[17319]: 2007/12/03_10:20:16 info: notify_crmd: Transition 3 status: te_complete - <null>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: - <cib epoch="2" num_updates="7"/>
tengine[17319]: 2007/12/03_10:20:58 info: update_abort_priority: Abort priority upgraded to 1000000
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: + <cib epoch="3" num_updates="1">
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +   <configuration>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +     <resources>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +       <group id="grpDummy">
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +         <primitive id="prmDummy">
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +           <operations>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +             <op disabled="true" id="opDummyMonitor"/>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +           </operations>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +         </primitive>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +       </group>
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +     </resources>
crmd[17310]: 2007/12/03_10:20:58 info: do_state_transition: State transition S_IDLE -> S_POLICY_ENGINE [ input=I_PE_CALC cause=C_IPC_MESSAGE origin=route_message ]
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: +   </configuration>
crmd[17310]: 2007/12/03_10:20:58 info: do_state_transition: All 2 cluster nodes are eligible to run resources.
cib[17306]: 2007/12/03_10:20:58 info: log_data_element: cib:diff: + </cib>
cib[17335]: 2007/12/03_10:20:58 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17335]: 2007/12/03_10:20:58 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17335]: 2007/12/03_10:20:58 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
pengine[17320]: 2007/12/03_10:20:58 notice: unpack_config: On loss of CCM Quorum: Ignore
pengine[17320]: 2007/12/03_10:20:58 info: determine_online_status: Node prec370e is online
pengine[17320]: 2007/12/03_10:20:58 info: determine_online_status: Node prec370d is online
pengine[17320]: 2007/12/03_10:20:58 notice: group_print: Resource Group: grpDummy
pengine[17320]: 2007/12/03_10:20:58 notice: native_print:     prmDummy	(heartbeat::ocf:Dummy):	Started prec370d
pengine[17320]: 2007/12/03_10:20:58 ERROR: unpack_operation: Specifying on_fail=fence and stonith-enabled=false makes no sense
pengine[17320]: 2007/12/03_10:20:58 info: check_action_definition: Orphan action will be stopped: prmDummy_monitor_10000 on prec370d
pengine[17320]: 2007/12/03_10:20:58 ERROR: unpack_operation: Specifying on_fail=fence and stonith-enabled=false makes no sense
pengine[17320]: 2007/12/03_10:20:58 ERROR: unpack_operation: Specifying on_fail=fence and stonith-enabled=false makes no sense
pengine[17320]: 2007/12/03_10:20:58 notice: NoRoleChange: Leave resource prmDummy	(prec370d)
crmd[17310]: 2007/12/03_10:20:58 info: do_state_transition: State transition S_POLICY_ENGINE -> S_TRANSITION_ENGINE [ input=I_PE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
tengine[17319]: 2007/12/03_10:20:58 info: unpack_graph: Unpacked transition 4: 1 actions in 1 synapses
tengine[17319]: 2007/12/03_10:20:58 info: send_rsc_command: Initiating action 6: prmDummy_cancel_10000 on prec370d
pengine[17320]: 2007/12/03_10:20:58 info: process_pe_message: Transition 4: PEngine Input stored in: /var/lib/heartbeat/pengine/pe-input-4.bz2
cib[17335]: 2007/12/03_10:20:58 info: write_cib_contents: Wrote version 0.3.1 of the CIB to disk (digest: 1524fff6a5e40955c817b725551e3b59)
pengine[17320]: 2007/12/03_10:20:58 info: process_pe_message: Configuration ERRORs found during PE processing.  Please run "crm_verify -L" to identify issues.
cib[17335]: 2007/12/03_10:20:58 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml (digest: /var/lib/heartbeat/crm/cib.xml.sig)
cib[17335]: 2007/12/03_10:20:58 info: retrieveCib: Reading cluster configuration from: /var/lib/heartbeat/crm/cib.xml.last (digest: /var/lib/heartbeat/crm/cib.xml.sig.last)
tengine[17319]: 2007/12/03_10:20:59 info: process_te_message: Processing (N)ACK lrm_invoke-lrmd-1196644859-6 from prec370d
tengine[17319]: 2007/12/03_10:20:59 info: match_graph_event: Action prmDummy_monitor_10000 (6) confirmed on prec370d (rc=0)
tengine[17319]: 2007/12/03_10:20:59 info: run_graph: Transition 4: (Complete=1, Pending=0, Fired=0, Skipped=0, Incomplete=0)
tengine[17319]: 2007/12/03_10:20:59 info: notify_crmd: Transition 4 status: te_complete - <null>
crmd[17310]: 2007/12/03_10:20:59 info: do_state_transition: State transition S_TRANSITION_ENGINE -> S_IDLE [ input=I_TE_SUCCESS cause=C_IPC_MESSAGE origin=route_message ]
crmd[17310]: 2007/12/03_10:22:14 info: handle_request: Current ping state: S_IDLE
