builder: b2g-inbound_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-027 starttime: 1448072615.18 results: success (0) buildid: 20151120181131 builduid: 5b27578924d7439db79513ae4430be92 revision: 36228281fd55bdccab7869c8c57b03f4bd2daf5b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.182650) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.183142) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.183426) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006549 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.206585) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.206885) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.222177) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.222459) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004628 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.272160) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.272517) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.272983) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.273284) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-20 18:23:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 64.1M=0s 2015-11-20 18:23:35 (64.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.158781 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.444215) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.444553) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022067 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.493838) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:35.494301) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev 36228281fd55bdccab7869c8c57b03f4bd2daf5b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/b2g-inbound --rev 36228281fd55bdccab7869c8c57b03f4bd2daf5b --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-20 18:23:35,614 truncating revision to first 12 chars 2015-11-20 18:23:35,614 Setting DEBUG logging. 2015-11-20 18:23:35,614 attempt 1/10 2015-11-20 18:23:35,614 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/36228281fd55?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-20 18:23:35,879 unpacking tar archive at: b2g-inbound-36228281fd55/testing/mozharness/ program finished with exit code 0 elapsedTime=0.543119 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:36.066838) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:36.067123) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:36.103160) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:36.103408) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-20 18:23:36.103781) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2015-11-20 18:23:36.104073) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'B2G-Inbound-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'B2G-Inbound-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:23:36 INFO - MultiFileLogger online at 20151120 18:23:36 in /builds/slave/test 18:23:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound-Non-PGO 18:23:36 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:23:36 INFO - {'append_to_log': False, 18:23:36 INFO - 'base_work_dir': '/builds/slave/test', 18:23:36 INFO - 'blob_upload_branch': 'B2G-Inbound-Non-PGO', 18:23:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:23:36 INFO - 'branch': 'B2G-Inbound-Non-PGO', 18:23:36 INFO - 'buildbot_json_path': 'buildprops.json', 18:23:36 INFO - 'config_files': ('talos/linux_config.py',), 18:23:36 INFO - 'default_actions': ('clobber', 18:23:36 INFO - 'read-buildbot-config', 18:23:36 INFO - 'download-and-extract', 18:23:36 INFO - 'populate-webroot', 18:23:36 INFO - 'create-virtualenv', 18:23:36 INFO - 'install', 18:23:36 INFO - 'run-tests'), 18:23:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:23:36 INFO - 'download_minidump_stackwalk': True, 18:23:36 INFO - 'download_symbols': 'ondemand', 18:23:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:23:36 INFO - 'tooltool.py': '/tools/tooltool.py', 18:23:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:23:36 INFO - '/tools/misc-python/virtualenv.py')}, 18:23:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:23:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:23:36 INFO - 'installer_path': 'installer.exe', 18:23:36 INFO - 'log_level': 'info', 18:23:36 INFO - 'log_name': 'talos', 18:23:36 INFO - 'log_to_console': True, 18:23:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:23:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:23:36 INFO - 'opt_config_files': (), 18:23:36 INFO - 'pip_index': False, 18:23:36 INFO - 'sps_profile': False, 18:23:36 INFO - 'sps_profile_interval': 0, 18:23:36 INFO - 'suite': 'dromaeojs', 18:23:36 INFO - 'system_bits': '64', 18:23:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:23:36 INFO - 'title': 'talos-linux64-ix-027', 18:23:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:23:36 INFO - 'use_talos_json': True, 18:23:36 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:23:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:23:36 INFO - 'work_dir': 'build'} 18:23:36 INFO - ##### 18:23:36 INFO - ##### Running clobber step. 18:23:36 INFO - ##### 18:23:36 INFO - Running pre-action listener: _resource_record_pre_action 18:23:36 INFO - Running main action method: clobber 18:23:36 INFO - rmtree: /builds/slave/test/build 18:23:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:23:36 INFO - Running post-action listener: _resource_record_post_action 18:23:36 INFO - ##### 18:23:36 INFO - ##### Running read-buildbot-config step. 18:23:36 INFO - ##### 18:23:36 INFO - Running pre-action listener: _resource_record_pre_action 18:23:36 INFO - Running main action method: read_buildbot_config 18:23:36 INFO - Using buildbot properties: 18:23:36 INFO - { 18:23:36 INFO - "properties": { 18:23:36 INFO - "buildnumber": 768, 18:23:36 INFO - "product": "firefox", 18:23:36 INFO - "script_repo_revision": "production", 18:23:36 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 18:23:36 INFO - "repository": "", 18:23:36 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound talos dromaeojs", 18:23:36 INFO - "buildid": "20151120181131", 18:23:36 INFO - "slavename": "talos-linux64-ix-027", 18:23:36 INFO - "pgo_build": "False", 18:23:36 INFO - "basedir": "/builds/slave/test", 18:23:36 INFO - "project": "", 18:23:36 INFO - "platform": "ubuntu64_hw", 18:23:36 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 18:23:36 INFO - "slavebuilddir": "test", 18:23:36 INFO - "scheduler": "tests-b2g-inbound-linux64-talos", 18:23:36 INFO - "branch": "b2g-inbound", 18:23:36 INFO - "repo_path": "integration/b2g-inbound", 18:23:36 INFO - "stage_platform": "linux64", 18:23:36 INFO - "builduid": "5b27578924d7439db79513ae4430be92", 18:23:36 INFO - "revision": "36228281fd55bdccab7869c8c57b03f4bd2daf5b" 18:23:36 INFO - }, 18:23:36 INFO - "sourcestamp": { 18:23:36 INFO - "repository": "", 18:23:36 INFO - "hasPatch": false, 18:23:36 INFO - "project": "", 18:23:36 INFO - "branch": "b2g-inbound-linux64-talos", 18:23:36 INFO - "changes": [ 18:23:36 INFO - { 18:23:36 INFO - "category": null, 18:23:36 INFO - "files": [ 18:23:36 INFO - { 18:23:36 INFO - "url": null, 18:23:36 INFO - "name": "https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 18:23:36 INFO - } 18:23:36 INFO - ], 18:23:36 INFO - "repository": "", 18:23:36 INFO - "rev": "36228281fd55bdccab7869c8c57b03f4bd2daf5b", 18:23:36 INFO - "who": "glacroix@mozilla.com", 18:23:36 INFO - "when": 1448072571, 18:23:36 INFO - "number": 6691691, 18:23:36 INFO - "comments": "Bug 1223661 - Update base-tester, tester to node v4.2.2 (LTS). r=garndt", 18:23:36 INFO - "project": "", 18:23:36 INFO - "at": "Fri 20 Nov 2015 18:22:51", 18:23:36 INFO - "branch": "b2g-inbound-linux64-talos", 18:23:36 INFO - "revlink": "", 18:23:36 INFO - "properties": [ 18:23:36 INFO - [ 18:23:36 INFO - "buildid", 18:23:36 INFO - "20151120181131", 18:23:36 INFO - "Change" 18:23:36 INFO - ], 18:23:36 INFO - [ 18:23:36 INFO - "builduid", 18:23:36 INFO - "5b27578924d7439db79513ae4430be92", 18:23:36 INFO - "Change" 18:23:36 INFO - ], 18:23:36 INFO - [ 18:23:36 INFO - "pgo_build", 18:23:36 INFO - "False", 18:23:36 INFO - "Change" 18:23:36 INFO - ] 18:23:36 INFO - ], 18:23:36 INFO - "revision": "36228281fd55bdccab7869c8c57b03f4bd2daf5b" 18:23:36 INFO - } 18:23:36 INFO - ], 18:23:36 INFO - "revision": "36228281fd55bdccab7869c8c57b03f4bd2daf5b" 18:23:36 INFO - } 18:23:36 INFO - } 18:23:36 INFO - Found installer url https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 18:23:36 INFO - Running post-action listener: _resource_record_post_action 18:23:36 INFO - ##### 18:23:36 INFO - ##### Running download-and-extract step. 18:23:36 INFO - ##### 18:23:36 INFO - Running pre-action listener: _resource_record_pre_action 18:23:36 INFO - Running main action method: download_and_extract 18:23:36 INFO - mkdir: /builds/slave/test/build/tests 18:23:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:36 INFO - https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 18:23:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/test_packages.json 18:23:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/test_packages.json 18:23:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 18:23:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 18:23:37 INFO - Downloaded 1302 bytes. 18:23:37 INFO - Reading from file /builds/slave/test/build/test_packages.json 18:23:37 INFO - Using the following test package requirements: 18:23:37 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 18:23:37 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:23:37 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 18:23:37 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:23:37 INFO - u'jsshell-linux-x86_64.zip'], 18:23:37 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:23:37 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 18:23:37 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 18:23:37 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:23:37 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 18:23:37 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:23:37 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 18:23:37 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:23:37 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 18:23:37 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 18:23:37 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:23:37 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 18:23:37 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:23:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:37 INFO - https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:23:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:23:38 INFO - Downloaded 21339056 bytes. 18:23:38 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 18:23:38 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:38 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 18:23:39 INFO - Return code: 0 18:23:39 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 18:23:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:39 INFO - https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:23:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:23:41 INFO - Downloaded 21339056 bytes. 18:23:41 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 18:23:41 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:23:41 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 18:23:43 INFO - Return code: 0 18:23:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:43 INFO - https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 18:23:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 18:23:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 18:23:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 18:23:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:23:45 INFO - Downloaded 11130997 bytes. 18:23:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 18:23:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 18:23:45 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 18:23:45 INFO - Return code: 0 18:23:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:45 INFO - https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 18:23:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:23:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:23:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:23:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 18:23:46 INFO - Downloaded 55894992 bytes. 18:23:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:23:46 INFO - mkdir: /builds/slave/test/properties 18:23:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:23:46 INFO - Writing to file /builds/slave/test/properties/build_url 18:23:46 INFO - Contents: 18:23:46 INFO - build_url:https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:23:46 INFO - Running post-action listener: _resource_record_post_action 18:23:46 INFO - Running post-action listener: set_extra_try_arguments 18:23:46 INFO - ##### 18:23:46 INFO - ##### Running populate-webroot step. 18:23:46 INFO - ##### 18:23:46 INFO - Running pre-action listener: _resource_record_pre_action 18:23:46 INFO - Running main action method: populate_webroot 18:23:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:23:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:23:46 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 18:23:46 INFO - '../fennec_ids.txt'], 18:23:46 INFO - 'tests': ['tcheck2']}, 18:23:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:23:46 INFO - '--tppagecycles', 18:23:46 INFO - '7'], 18:23:46 INFO - 'tests': ['tsvgm']}}, 18:23:46 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 18:23:46 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:23:46 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:23:46 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:23:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:23:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:23:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'tests': ['damp', 'tps']}, 18:23:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['damp', 'tps']}, 18:23:46 INFO - 'g3': {'tests': ['dromaeo_dom']}, 18:23:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:23:46 INFO - 'other': {'tests': ['a11yr', 18:23:46 INFO - 'ts_paint', 18:23:46 INFO - 'tpaint', 18:23:46 INFO - 'sessionrestore', 18:23:46 INFO - 'sessionrestore_no_auto_restore']}, 18:23:46 INFO - 'other-e10s': {'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['a11yr', 18:23:46 INFO - 'ts_paint', 18:23:46 INFO - 'tpaint', 18:23:46 INFO - 'sessionrestore', 18:23:46 INFO - 'sessionrestore_no_auto_restore']}, 18:23:46 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['a11yr', 18:23:46 INFO - 'ts_paint', 18:23:46 INFO - 'tpaint', 18:23:46 INFO - 'sessionrestore', 18:23:46 INFO - 'sessionrestore_no_auto_restore']}, 18:23:46 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['a11yr', 18:23:46 INFO - 'ts_paint', 18:23:46 INFO - 'tpaint', 18:23:46 INFO - 'sessionrestore', 18:23:46 INFO - 'sessionrestore_no_auto_restore']}, 18:23:46 INFO - 'other_l64': {'tests': ['a11yr', 18:23:46 INFO - 'ts_paint', 18:23:46 INFO - 'tpaint', 18:23:46 INFO - 'sessionrestore', 18:23:46 INFO - 'sessionrestore_no_auto_restore']}, 18:23:46 INFO - 'other_nol64': {'tests': ['a11yr', 18:23:46 INFO - 'ts_paint', 18:23:46 INFO - 'tpaint', 18:23:46 INFO - 'sessionrestore', 18:23:46 INFO - 'sessionrestore_no_auto_restore']}, 18:23:46 INFO - 'svgr': {'tests': ['tsvgx', 18:23:46 INFO - 'tsvgr_opacity', 18:23:46 INFO - 'tart', 18:23:46 INFO - 'tscrollx', 18:23:46 INFO - 'cart']}, 18:23:46 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['tsvgx', 18:23:46 INFO - 'tsvgr_opacity', 18:23:46 INFO - 'tart', 18:23:46 INFO - 'tscrollx', 18:23:46 INFO - 'cart']}, 18:23:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'tests': ['tp5o']}, 18:23:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'talos_options': ['--e10s'], 18:23:46 INFO - 'tests': ['tp5o']}, 18:23:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'talos_options': ['--xperf_path', 18:23:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:23:46 INFO - 'tests': ['tp5n']}, 18:23:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:23:46 INFO - 'talos_options': ['--e10s', 18:23:46 INFO - '--xperf_path', 18:23:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:23:46 INFO - 'tests': ['tp5n']}}, 18:23:46 INFO - 'talos.zip': {'path': '', 18:23:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:23:46 INFO - Running post-action listener: _resource_record_post_action 18:23:46 INFO - ##### 18:23:46 INFO - ##### Running create-virtualenv step. 18:23:46 INFO - ##### 18:23:46 INFO - Running pre-action listener: _resource_record_pre_action 18:23:46 INFO - Running main action method: create_virtualenv 18:23:46 INFO - Creating virtualenv /builds/slave/test/build/venv 18:23:46 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 18:23:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:23:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:23:46 INFO - Using real prefix '/usr' 18:23:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:23:47 INFO - Installing distribute.............................................................................................................................................................................................done. 18:23:49 INFO - Installing pip.................done. 18:23:49 INFO - Return code: 0 18:23:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:23:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:23:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:23:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad9b1d6c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17a76c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1858900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:23:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 18:23:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 18:23:49 INFO - Using env: {'DISPLAY': ':0', 18:23:49 INFO - 'HOME': '/home/cltbld', 18:23:49 INFO - 'LANG': 'en_US.UTF-8', 18:23:49 INFO - 'LANGUAGE': 'en_US:en', 18:23:49 INFO - 'LOGNAME': 'cltbld', 18:23:49 INFO - 'MAIL': '/var/mail/cltbld', 18:23:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:23:49 INFO - 'MOZ_NO_REMOTE': '1', 18:23:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:23:49 INFO - 'NO_EM_RESTART': '1', 18:23:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:23:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:23:49 INFO - 'PWD': '/builds/slave/test', 18:23:49 INFO - 'SHELL': '/bin/bash', 18:23:49 INFO - 'SHLVL': '1', 18:23:49 INFO - 'TERM': 'linux', 18:23:49 INFO - 'TMOUT': '86400', 18:23:49 INFO - 'USER': 'cltbld', 18:23:49 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:23:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:23:49 INFO - '_': '/tools/buildbot/bin/python'} 18:23:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:23:49 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 18:23:49 INFO - Cleaning up... 18:23:49 INFO - Return code: 0 18:23:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 18:23:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:23:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:23:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad9b1d6c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17a76c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1858900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:23:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 18:23:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 18:23:49 INFO - Using env: {'DISPLAY': ':0', 18:23:49 INFO - 'HOME': '/home/cltbld', 18:23:49 INFO - 'LANG': 'en_US.UTF-8', 18:23:49 INFO - 'LANGUAGE': 'en_US:en', 18:23:49 INFO - 'LOGNAME': 'cltbld', 18:23:49 INFO - 'MAIL': '/var/mail/cltbld', 18:23:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:23:49 INFO - 'MOZ_NO_REMOTE': '1', 18:23:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:23:49 INFO - 'NO_EM_RESTART': '1', 18:23:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:23:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:23:49 INFO - 'PWD': '/builds/slave/test', 18:23:49 INFO - 'SHELL': '/bin/bash', 18:23:49 INFO - 'SHLVL': '1', 18:23:49 INFO - 'TERM': 'linux', 18:23:49 INFO - 'TMOUT': '86400', 18:23:49 INFO - 'USER': 'cltbld', 18:23:49 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:23:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:23:49 INFO - '_': '/tools/buildbot/bin/python'} 18:23:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:23:49 INFO - Downloading/unpacking psutil>=0.7.1 18:23:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:51 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 18:23:51 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 18:23:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:23:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:23:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:23:51 INFO - Installing collected packages: psutil 18:23:51 INFO - Running setup.py install for psutil 18:23:51 INFO - building 'psutil._psutil_linux' extension 18:23:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 18:23:51 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 18:23:51 INFO - building 'psutil._psutil_posix' extension 18:23:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 18:23:51 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 18:23:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:23:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:23:51 INFO - Successfully installed psutil 18:23:51 INFO - Cleaning up... 18:23:51 INFO - Return code: 0 18:23:51 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 18:23:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:23:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:23:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad9b1d6c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17a76c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1858900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:23:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 18:23:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 18:23:51 INFO - Using env: {'DISPLAY': ':0', 18:23:51 INFO - 'HOME': '/home/cltbld', 18:23:51 INFO - 'LANG': 'en_US.UTF-8', 18:23:51 INFO - 'LANGUAGE': 'en_US:en', 18:23:51 INFO - 'LOGNAME': 'cltbld', 18:23:51 INFO - 'MAIL': '/var/mail/cltbld', 18:23:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:23:51 INFO - 'MOZ_NO_REMOTE': '1', 18:23:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:23:51 INFO - 'NO_EM_RESTART': '1', 18:23:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:23:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:23:51 INFO - 'PWD': '/builds/slave/test', 18:23:51 INFO - 'SHELL': '/bin/bash', 18:23:51 INFO - 'SHLVL': '1', 18:23:51 INFO - 'TERM': 'linux', 18:23:51 INFO - 'TMOUT': '86400', 18:23:51 INFO - 'USER': 'cltbld', 18:23:51 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:23:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:23:51 INFO - '_': '/tools/buildbot/bin/python'} 18:23:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:23:52 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 18:23:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:53 INFO - Downloading mozsystemmonitor-0.0.tar.gz 18:23:53 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 18:23:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:23:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 18:23:53 INFO - Installing collected packages: mozsystemmonitor 18:23:53 INFO - Running setup.py install for mozsystemmonitor 18:23:53 INFO - Successfully installed mozsystemmonitor 18:23:53 INFO - Cleaning up... 18:23:54 INFO - Return code: 0 18:23:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:23:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:23:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:23:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad9b1d6c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17a76c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1858900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:23:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 18:23:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 18:23:54 INFO - Using env: {'DISPLAY': ':0', 18:23:54 INFO - 'HOME': '/home/cltbld', 18:23:54 INFO - 'LANG': 'en_US.UTF-8', 18:23:54 INFO - 'LANGUAGE': 'en_US:en', 18:23:54 INFO - 'LOGNAME': 'cltbld', 18:23:54 INFO - 'MAIL': '/var/mail/cltbld', 18:23:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:23:54 INFO - 'MOZ_NO_REMOTE': '1', 18:23:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:23:54 INFO - 'NO_EM_RESTART': '1', 18:23:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:23:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:23:54 INFO - 'PWD': '/builds/slave/test', 18:23:54 INFO - 'SHELL': '/bin/bash', 18:23:54 INFO - 'SHLVL': '1', 18:23:54 INFO - 'TERM': 'linux', 18:23:54 INFO - 'TMOUT': '86400', 18:23:54 INFO - 'USER': 'cltbld', 18:23:54 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:23:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:23:54 INFO - '_': '/tools/buildbot/bin/python'} 18:23:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:23:54 INFO - Downloading/unpacking blobuploader==1.2.4 18:23:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:55 INFO - Downloading blobuploader-1.2.4.tar.gz 18:23:55 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 18:23:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:23:55 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:23:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 18:23:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:23:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:23:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:23:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:23:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:23:56 INFO - Downloading docopt-0.6.1.tar.gz 18:23:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 18:23:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:23:56 INFO - Installing collected packages: blobuploader, requests, docopt 18:23:56 INFO - Running setup.py install for blobuploader 18:23:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:23:56 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:23:56 INFO - Running setup.py install for requests 18:23:57 INFO - Running setup.py install for docopt 18:23:57 INFO - Successfully installed blobuploader requests docopt 18:23:57 INFO - Cleaning up... 18:23:57 INFO - Return code: 0 18:23:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:23:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:23:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:23:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:23:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:23:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad9b1d6c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17a76c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1858900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:23:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 18:23:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:23:57 INFO - Using env: {'DISPLAY': ':0', 18:23:57 INFO - 'HOME': '/home/cltbld', 18:23:57 INFO - 'LANG': 'en_US.UTF-8', 18:23:57 INFO - 'LANGUAGE': 'en_US:en', 18:23:57 INFO - 'LOGNAME': 'cltbld', 18:23:57 INFO - 'MAIL': '/var/mail/cltbld', 18:23:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:23:57 INFO - 'MOZ_NO_REMOTE': '1', 18:23:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:23:57 INFO - 'NO_EM_RESTART': '1', 18:23:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:23:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:23:57 INFO - 'PWD': '/builds/slave/test', 18:23:57 INFO - 'SHELL': '/bin/bash', 18:23:57 INFO - 'SHLVL': '1', 18:23:57 INFO - 'TERM': 'linux', 18:23:57 INFO - 'TMOUT': '86400', 18:23:57 INFO - 'USER': 'cltbld', 18:23:57 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:23:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:23:57 INFO - '_': '/tools/buildbot/bin/python'} 18:23:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:23:57 INFO - Running setup.py (path:/tmp/pip-eomI_m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:23:57 INFO - Running setup.py (path:/tmp/pip-uXLYD7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:23:57 INFO - Running setup.py (path:/tmp/pip-MmAsDj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:23:57 INFO - Running setup.py (path:/tmp/pip-ZUQRbb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:23:57 INFO - Running setup.py (path:/tmp/pip-y6DmIG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:23:57 INFO - Running setup.py (path:/tmp/pip-Qrjhxj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:23:57 INFO - Running setup.py (path:/tmp/pip-EvybIh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:23:57 INFO - Running setup.py (path:/tmp/pip-iNeDck-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:23:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:23:57 INFO - Running setup.py (path:/tmp/pip-BYjpxn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:23:58 INFO - Running setup.py (path:/tmp/pip-JQz4Su-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:23:58 INFO - Running setup.py (path:/tmp/pip-DYwIRr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:23:58 INFO - Running setup.py (path:/tmp/pip-r1zsj9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:23:58 INFO - Running setup.py (path:/tmp/pip-s7lUFz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:23:58 INFO - Running setup.py (path:/tmp/pip-nKfzAO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:23:58 INFO - Running setup.py (path:/tmp/pip-424d9m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:23:58 INFO - Running setup.py (path:/tmp/pip-Y9DIlo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:23:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:23:58 INFO - Running setup.py (path:/tmp/pip-2IE6CM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:23:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:23:58 INFO - Running setup.py install for manifestparser 18:23:58 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:23:58 INFO - Running setup.py install for mozcrash 18:23:58 INFO - Running setup.py install for mozdebug 18:23:58 INFO - Running setup.py install for mozdevice 18:23:59 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Running setup.py install for mozfile 18:23:59 INFO - Running setup.py install for mozhttpd 18:23:59 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Running setup.py install for mozinfo 18:23:59 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Running setup.py install for mozInstall 18:23:59 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Running setup.py install for mozleak 18:23:59 INFO - Running setup.py install for mozlog 18:23:59 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Running setup.py install for moznetwork 18:23:59 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Running setup.py install for mozprocess 18:23:59 INFO - Running setup.py install for mozprofile 18:23:59 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:23:59 INFO - Running setup.py install for mozrunner 18:24:00 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:24:00 INFO - Running setup.py install for mozscreenshot 18:24:00 INFO - Running setup.py install for moztest 18:24:00 INFO - Running setup.py install for mozversion 18:24:00 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:24:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:24:00 INFO - Cleaning up... 18:24:00 INFO - Return code: 0 18:24:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:24:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:24:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:24:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:24:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:24:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:24:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:24:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad9b1d6c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17a76c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1858900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:24:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 18:24:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:24:00 INFO - Using env: {'DISPLAY': ':0', 18:24:00 INFO - 'HOME': '/home/cltbld', 18:24:00 INFO - 'LANG': 'en_US.UTF-8', 18:24:00 INFO - 'LANGUAGE': 'en_US:en', 18:24:00 INFO - 'LOGNAME': 'cltbld', 18:24:00 INFO - 'MAIL': '/var/mail/cltbld', 18:24:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:24:00 INFO - 'MOZ_NO_REMOTE': '1', 18:24:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:24:00 INFO - 'NO_EM_RESTART': '1', 18:24:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:24:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:24:00 INFO - 'PWD': '/builds/slave/test', 18:24:00 INFO - 'SHELL': '/bin/bash', 18:24:00 INFO - 'SHLVL': '1', 18:24:00 INFO - 'TERM': 'linux', 18:24:00 INFO - 'TMOUT': '86400', 18:24:00 INFO - 'USER': 'cltbld', 18:24:00 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:24:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:24:00 INFO - '_': '/tools/buildbot/bin/python'} 18:24:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:24:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:24:00 INFO - Running setup.py (path:/tmp/pip-R1t9YV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:24:00 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 18:24:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:24:00 INFO - Running setup.py (path:/tmp/pip-pkCLWE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:24:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:24:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:24:00 INFO - Running setup.py (path:/tmp/pip-B3Z89b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:24:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 18:24:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:24:00 INFO - Running setup.py (path:/tmp/pip-WzzZ57-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:24:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:24:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:24:00 INFO - Running setup.py (path:/tmp/pip-ACGGs6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:24:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 18:24:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:24:00 INFO - Running setup.py (path:/tmp/pip-knJk_F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:24:01 INFO - Running setup.py (path:/tmp/pip-SDWY5V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:24:01 INFO - Running setup.py (path:/tmp/pip-e0aFCb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:24:01 INFO - Running setup.py (path:/tmp/pip-ZFf4Uf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:24:01 INFO - Running setup.py (path:/tmp/pip-Ud6dHr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:24:01 INFO - Running setup.py (path:/tmp/pip-HK2AFj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:24:01 INFO - Running setup.py (path:/tmp/pip-YvB0xW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:24:01 INFO - Running setup.py (path:/tmp/pip-zOBKED-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:24:01 INFO - Running setup.py (path:/tmp/pip-7GD90N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:24:01 INFO - Running setup.py (path:/tmp/pip-2V9kfr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:24:01 INFO - Running setup.py (path:/tmp/pip-DPNcvY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 18:24:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:24:01 INFO - Running setup.py (path:/tmp/pip-mkXh6t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:24:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:24:01 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:24:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:24:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:24:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:24:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:24:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:24:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:24:03 INFO - Downloading blessings-1.5.1.tar.gz 18:24:03 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 18:24:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:24:03 INFO - Installing collected packages: blessings 18:24:03 INFO - Running setup.py install for blessings 18:24:03 INFO - Successfully installed blessings 18:24:03 INFO - Cleaning up... 18:24:03 INFO - Return code: 0 18:24:03 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:24:03 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:24:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:24:03 INFO - Reading from file tmpfile_stdout 18:24:03 INFO - Current package versions: 18:24:03 INFO - argparse == 1.2.1 18:24:03 INFO - blessings == 1.5.1 18:24:03 INFO - blobuploader == 1.2.4 18:24:03 INFO - docopt == 0.6.1 18:24:03 INFO - manifestparser == 1.1 18:24:03 INFO - mozInstall == 1.12 18:24:03 INFO - mozcrash == 0.16 18:24:03 INFO - mozdebug == 0.1 18:24:03 INFO - mozdevice == 0.47 18:24:03 INFO - mozfile == 1.2 18:24:03 INFO - mozhttpd == 0.7 18:24:03 INFO - mozinfo == 0.9 18:24:03 INFO - mozleak == 0.1 18:24:03 INFO - mozlog == 3.0 18:24:03 INFO - moznetwork == 0.27 18:24:03 INFO - mozprocess == 0.22 18:24:03 INFO - mozprofile == 0.27 18:24:03 INFO - mozrunner == 6.11 18:24:03 INFO - mozscreenshot == 0.1 18:24:03 INFO - mozsystemmonitor == 0.0 18:24:03 INFO - moztest == 0.7 18:24:03 INFO - mozversion == 1.4 18:24:03 INFO - psutil == 3.1.1 18:24:03 INFO - requests == 1.2.3 18:24:03 INFO - wsgiref == 0.1.2 18:24:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:24:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:24:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:24:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:24:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:24:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:24:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:24:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad9b1d6c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17a76c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1858900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 18:24:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 18:24:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 18:24:03 INFO - Using env: {'DISPLAY': ':0', 18:24:03 INFO - 'HOME': '/home/cltbld', 18:24:03 INFO - 'LANG': 'en_US.UTF-8', 18:24:03 INFO - 'LANGUAGE': 'en_US:en', 18:24:03 INFO - 'LOGNAME': 'cltbld', 18:24:03 INFO - 'MAIL': '/var/mail/cltbld', 18:24:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:24:03 INFO - 'MOZ_NO_REMOTE': '1', 18:24:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:24:03 INFO - 'NO_EM_RESTART': '1', 18:24:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:24:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:24:03 INFO - 'PWD': '/builds/slave/test', 18:24:03 INFO - 'SHELL': '/bin/bash', 18:24:03 INFO - 'SHLVL': '1', 18:24:03 INFO - 'TERM': 'linux', 18:24:03 INFO - 'TMOUT': '86400', 18:24:03 INFO - 'USER': 'cltbld', 18:24:03 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:24:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:24:03 INFO - '_': '/tools/buildbot/bin/python'} 18:24:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 18:24:04 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:24:04 INFO - Cleaning up... 18:24:04 INFO - Return code: 0 18:24:04 INFO - Running post-action listener: _resource_record_post_action 18:24:04 INFO - Running post-action listener: _start_resource_monitoring 18:24:04 INFO - Starting resource monitoring. 18:24:04 INFO - ##### 18:24:04 INFO - ##### Running install step. 18:24:04 INFO - ##### 18:24:04 INFO - Running pre-action listener: _resource_record_pre_action 18:24:04 INFO - Running main action method: install 18:24:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:24:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:24:04 INFO - Reading from file tmpfile_stdout 18:24:04 INFO - Detecting whether we're running mozinstall >=1.0... 18:24:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:24:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:24:04 INFO - Reading from file tmpfile_stdout 18:24:04 INFO - Output received: 18:24:04 INFO - Usage: mozinstall [options] installer 18:24:04 INFO - Options: 18:24:04 INFO - -h, --help show this help message and exit 18:24:04 INFO - -d DEST, --destination=DEST 18:24:04 INFO - Directory to install application into. [default: 18:24:04 INFO - "/builds/slave/test"] 18:24:04 INFO - --app=APP Application being installed. [default: firefox] 18:24:04 INFO - mkdir: /builds/slave/test/build/application 18:24:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 18:24:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 18:24:18 INFO - Reading from file tmpfile_stdout 18:24:18 INFO - Output received: 18:24:18 INFO - /builds/slave/test/build/application/firefox/firefox 18:24:18 INFO - Running post-action listener: _resource_record_post_action 18:24:18 INFO - ##### 18:24:18 INFO - ##### Running run-tests step. 18:24:18 INFO - ##### 18:24:18 INFO - Running pre-action listener: _resource_record_pre_action 18:24:18 INFO - Running main action method: run_tests 18:24:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:24:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:24:18 INFO - Python 2.7.3 18:24:18 INFO - Return code: 0 18:24:18 INFO - grabbing minidump binary from tooltool 18:24:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:24:18 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189eb70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18efdc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f0250>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:24:18 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 18:24:18 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 18:24:18 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:24:18 INFO - Return code: 0 18:24:18 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:24:18 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:24:18 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:24:18 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:24:18 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:24:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'B2G-Inbound-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost'] in /builds/slave/test/build 18:24:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName B2G-Inbound-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-027 --webServer localhost 18:24:18 INFO - Using env: {'DISPLAY': ':0', 18:24:18 INFO - 'HOME': '/home/cltbld', 18:24:18 INFO - 'LANG': 'en_US.UTF-8', 18:24:18 INFO - 'LANGUAGE': 'en_US:en', 18:24:18 INFO - 'LOGNAME': 'cltbld', 18:24:18 INFO - 'MAIL': '/var/mail/cltbld', 18:24:18 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:24:18 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:24:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:24:18 INFO - 'MOZ_NO_REMOTE': '1', 18:24:18 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:24:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:24:18 INFO - 'NO_EM_RESTART': '1', 18:24:18 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:24:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:24:18 INFO - 'PWD': '/builds/slave/test', 18:24:18 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:24:18 INFO - 'SHELL': '/bin/bash', 18:24:18 INFO - 'SHLVL': '1', 18:24:18 INFO - 'TERM': 'linux', 18:24:18 INFO - 'TMOUT': '86400', 18:24:18 INFO - 'USER': 'cltbld', 18:24:18 INFO - 'XDG_SESSION_COOKIE': '447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717', 18:24:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:24:18 INFO - '_': '/tools/buildbot/bin/python'} 18:24:18 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'B2G-Inbound-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost'] with output_timeout 3600 18:24:18 INFO - mozversion INFO | application_buildid: 20151120181131 18:24:18 INFO - mozversion INFO | application_changeset: 36228281fd55bdccab7869c8c57b03f4bd2daf5b 18:24:18 INFO - mozversion INFO | application_display_name: Nightly 18:24:18 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:24:18 INFO - mozversion INFO | application_name: Firefox 18:24:18 INFO - mozversion INFO | application_remotingname: firefox 18:24:18 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/b2g-inbound 18:24:18 INFO - mozversion INFO | application_vendor: Mozilla 18:24:18 INFO - mozversion INFO | application_version: 45.0a1 18:24:18 INFO - mozversion INFO | platform_buildid: 20151120181131 18:24:18 INFO - mozversion INFO | platform_changeset: 36228281fd55bdccab7869c8c57b03f4bd2daf5b 18:24:18 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/b2g-inbound 18:24:18 INFO - mozversion INFO | platform_version: 45.0a1 18:24:18 INFO - 2015-11-20 18:24:18,895 DEBUG : using testdate: 1448072658 18:24:18 INFO - 2015-11-20 18:24:18,895 DEBUG : actual date: 1448072658 18:24:18 INFO - 2015-11-20 18:24:18,904 INFO : starting webserver on 'localhost:42867' 18:24:18 INFO - 2015-11-20 18:24:18,905 INFO : Starting test suite talos-linux64-ix-027 18:24:18 INFO - 2015-11-20 18:24:18,905 INFO : Starting test dromaeo_css 18:24:18 INFO - 2015-11-20 18:24:18,905 DEBUG : operating with platform_type : linux_ 18:24:18 INFO - 2015-11-20 18:24:18,906 INFO : Initialising browser for dromaeo_css test... 18:24:18 INFO - 2015-11-20 18:24:18,922 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmz6VV8/profile http://localhost:42867/getInfo.html 18:24:23 INFO - 2015-11-20 18:24:23,343 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:24:23 INFO - 2015-11-20 18:24:23,343 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:24:23 INFO - 2015-11-20 18:24:23,343 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 18:24:23 INFO - 2015-11-20 18:24:23,343 DEBUG : BROWSER_OUTPUT: __metrics 18:24:23 INFO - 2015-11-20 18:24:23,581 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:24:25 INFO - 2015-11-20 18:24:25,092 INFO : Browser initialized. 18:24:25 INFO - 2015-11-20 18:24:25,093 INFO : Running cycle 1/1 for dromaeo_css test... 18:24:25 INFO - 2015-11-20 18:24:25,093 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmz6VV8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:24:37 INFO - 2015-11-20 18:24:37,086 DEBUG : BROWSER_OUTPUT: RSS: Main: 142036992 18:24:37 INFO - 2015-11-20 18:24:37,087 DEBUG : BROWSER_OUTPUT: 18:25:28 INFO - 2015-11-20 18:25:28,592 DEBUG : BROWSER_OUTPUT: 1448072728588 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 18:27:41 INFO - 2015-11-20 18:27:41,036 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42867/tests/dromaeo/cssquery-ext.html) 18:27:42 INFO - 2015-11-20 18:27:42,202 DEBUG : BROWSER_OUTPUT: RSS: Main: 257114112 18:27:42 INFO - 2015-11-20 18:27:42,202 DEBUG : BROWSER_OUTPUT: 18:30:44 INFO - 2015-11-20 18:30:44,761 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/dromaeo/cssquery-ext.html (next: http://localhost:42867/tests/dromaeo/cssquery-jquery.html) 18:30:45 INFO - 2015-11-20 18:30:45,342 DEBUG : BROWSER_OUTPUT: RSS: Main: 220733440 18:30:45 INFO - 2015-11-20 18:30:45,342 DEBUG : BROWSER_OUTPUT: 18:33:47 INFO - 2015-11-20 18:33:47,327 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42867/tests/dromaeo/cssquery-mootools.html) 18:33:47 INFO - 2015-11-20 18:33:47,900 DEBUG : BROWSER_OUTPUT: RSS: Main: 222015488 18:33:47 INFO - 2015-11-20 18:33:47,900 DEBUG : BROWSER_OUTPUT: 18:36:49 INFO - 2015-11-20 18:36:49,919 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42867/tests/dromaeo/cssquery-prototype.html) 18:36:50 INFO - 2015-11-20 18:36:50,501 DEBUG : BROWSER_OUTPUT: RSS: Main: 203862016 18:36:50 INFO - 2015-11-20 18:36:50,501 DEBUG : BROWSER_OUTPUT: 18:39:53 INFO - 2015-11-20 18:39:53,242 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42867/tests/dromaeo/cssquery-yui.html) 18:39:53 INFO - 2015-11-20 18:39:53,815 DEBUG : BROWSER_OUTPUT: RSS: Main: 209088512 18:39:53 INFO - 2015-11-20 18:39:53,815 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,344 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/dromaeo/cssquery-yui.html (next: http://localhost:42867/tests/dromaeo/cssquery-dojo.html) 18:42:56 INFO - 2015-11-20 18:42:56,590 DEBUG : BROWSER_OUTPUT: RSS: Main: 253014016 18:42:56 INFO - 2015-11-20 18:42:56,591 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,592 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:42:56 INFO - 2015-11-20 18:42:56,592 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:42:56 INFO - 2015-11-20 18:42:56,592 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:42:56 INFO - 2015-11-20 18:42:56,592 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:42:56 INFO - 2015-11-20 18:42:56,596 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2640.6171105189746;2716.701162872084;2717.605947137664;2737.1378015924984;2743.4238809849926;4426.159029784339;4552.726836389819;4670.369500117483;4687.624990000801;4695.741734204622;4524.208263553873;4566.748828814422;4576.725396476214;4616.607588354986;4621.168189725848;4285.121550082225;4294.441722576069;4335.588119128678;4446.911061778763;4452;4156.085661154541;4328.242557552431;4370.907273181705;4455.643548516127;4481.753503557303;4267.231898258312;4293.570642935712;4301.419308393358;4311.956880431187;4315.244832154361;4313.352997050436;4318.784060796979;4324.329728892027;4325.805338759732;4372.934405983913;4141.730787498803;4215.915681686349;4289.442372491588;4310.698251122422;4355.825766969318;4523.050159466516;4526.411566496367;4614.123316569841;4648.767561621906;4667.859964201046;5045.268436076785;5066.771995260222;5072.644914855961;5078.4159821620615;5127.9230811537855;4728.929066064012;5074.82238121664;5091.79632814687;5101.6173786965755;5115.104856650071;4571.017231295287;4595.839145629887;4608.262677971542;4660.790264438108;4711.929321060187;5186.92219616706;5215.452377500308;5219.478052194826;5222.060029194781;5230.3985041719925;4755.358026666425;4997.150484417658;5013.1227035268685;5017.422996355393;5060.089183946925;4992.326035985096;5003.849884503471;5019.698818070928;5058.241263810458;5077.162268225701;4956.553910148032;4990.051890140934;4994.625403094782;4998.450170481244;5044.54599086084;4748.19280722278;4951.207806750903;4963.181075122564;4965.280034394992;5008.749562521859;4094.2630326541507;4116.958830411718;4131.277026520347;4171.478565179353;4171.687123465752;3691.593924668338;3708.351038568294;3713.164537978933;3745.1198968242443;3753.887383378503;4323.718958267703;4358.607725304674;4370.497392799805;4373.606375426163;4406.1187762447635;4815.566599006036;4926.950730492721;4928.827491037797;5011.448740638527;5099.158638824627;4346.673999450054;4346.847860324873;4357.716748411343;4365.781710914505;4400.559944005638;4482.372467854503;4483.820647174077;4490.3040028795585;4490.50604433512;4528.5245049270015;4630.3286023525725;4701.5768580826525;4759.2147295697205;4766.308885211694;4819.518048195152;5070.391553013515;5073.289739436408;5086.7710953007945;5090.872728181677;5136.1268584340005;4810.869445680192;4819.638527110411;4821.421429428491;4823.927641085316;4858.489858564941;4773.284007398918;4870.829520966891;4872.561469467765;4899.877503062452;5016;5049.065922804293;5094.872628184325;5108.7445627717725;5110.284560161655;5160.561352285098;4940.580050695731;4946.134426475424;4947.158982972831;4949.901001980013;4952.628552858622;4681.625469962327;4786.2581299898575;4800.73595952226;4804.95195048045;4878.5853202476765;4868.3427737255015;4870.878228044327;4871.123197824426;4881.9511804881495;4888.706677599355;4996.175631020841;4996.825111121093;5000.874978125576;5002.674826136289;5016.648834581691;4627.6066534344955;4726.456457507431;4777.283407488904;4789.760511974457;4939.357883475125 18:42:56 INFO - 2015-11-20 18:42:56,596 DEBUG : BROWSER_OUTPUT: |1;ext.html;568.832194502622;574.6207503047988;578.6181120460496;584.7427132061893;584.9356570777214;28739.712602873966;29454.852725736368;38532.614673853255;39206.41190382146;39361;41964.16071678565;41984.790076049576;42379.364309535384;42530.787346063305;42599.78700106503;7004.754833580826;7859.096203936549;7999;8000.079990801074;8021.19788021199;7141.642917854112;10061.949690251538;10272.845907311395;10294.279400441972;10328.27702060856;10073.597056117747;10157.035081667267;10160.237982151331;10165.898341016606;10175.84736228957;7176.138863336381;7392.926070739331;10130.29087963839;10224.182065434747;10315.43265120418;10100.191984641211;10215;10255.641052563124;10277.126444252248;10280.948595256976;39804.20391592181;40164;40323.19353612941;40349.596504034875;40403.59596404028;2858.256853218178;2883.596296518489;2929.9267518312;3065.984670076635;3373.9156521086925;28751.990495539732;29080;29171.708282917323;29232;29274.560881586793;3469.757117001811;3498.2828520153307;3516.085817687394;3549.7515173937836;3639;223062;224027;224053.87973060194;224346;225257;52814.73592632089;54098.45901541013;58255.70872145697;58732.41267587355;58739;62192.689036555435;62957;63318.36681633125;63385.683071584346;63431.6828415855;12194.81707774384;12329.630111096501;12345.259284442962;12358.814617780741;12359.32023738703;9022.774430639287;9030.45817250967;9047.230985366186;9055.81888362229;9062.184403403593;18718.53203669919;18847.434576962714;18878;19700.60598788016;19757.901210494143;7615.961920190363;7807.921920780833;7898.60506974649;7945.801354966172;8030.558319292495;796.2475460689708;805.3275514945086;860.5267103093273;926.3885835348638;1008.8789345278467;23683.881580592333;26533.734662653125;27362.45275094487;27931.301717457227;28012.439751204864;935.7473482159779;940.8118376324762;947.2942657719905;1026.2149455666422;1092.2354351953663;12966.027547933943;13352.933235333761;13419.731605367839;13521.391537380841;13755.31223438824;275683;278117;280939;281258;282836;46702.29946550805;46755;46923;46958.76520617375;47036.29445558319;1195.9701007474882;1224.6142465123635;1230.4340003598265;1231.759806837676;1245.2404033539533;24118.276451705777;24673.62989555194;25317.620235696846;25400.491990160463;25606;37026.444603330434;37799;41571;43724.56275437205;45262.094758103995;169190;170792;171172;171289;171473;24531.63202551999;28209.43581128407;28483.43033139367;28524.714752852207;28565;28227.858860706387;39110.6088939107;39123.608763911994;39493.80253098716;39963;31986.68013319837;32821.507677385336;33856.49215261724;34113;34547.82726086454;30618.693813061585;30700.232494187825;32013.35973280568;33604.1598960028;34186.65813341835;30650.540241896837;30993.8450307747;31042.68957310398;31327.68672313339;31611.84194079107;26997.1900842975;30364.55053428084;30465.695343046285;30654.386912261183;30657;23207;23521.411964700335;23634.763652363257;23699.763002370444;23834.927428265422 18:42:56 INFO - 2015-11-20 18:42:56,600 DEBUG : BROWSER_OUTPUT: |2;jquery.html;335.9932801343973;339.3772427595362;343.54651859545396;344.03498187583835;347.9234568394952;12336.691582710437;12737.42681579329;14834.703305933876;14857.182854942974;15762.921185394085;14632.268386580681;14750.33623486943;15087.773683394731;15192.392304307841;15226.467073652424;4621.214393553088;4700.012997270577;4926.9753651231695;5061.924071138936;5069.847904562869;4968.70187788732;5023.3971923369245;5024.974875125619;5025.899482010358;5027.245913113025;4862.149123903303;4958.752062396884;4976.701397916118;4989;5007.298978143063;4844.709317440947;4845.515448455161;4847.636427267969;4867.269909513584;4893.412790465131;4279.101388708344;4385.47374315081;4387.429634147572;4391.5827996340295;4478.664100192498;19247.80752192474;19491.90254048735;19518.414447566454;19518.51203719904;19685.50786230356;1827.9360222392152;1999.100404817838;2010.2160157538572;2024.3926821953503;2094.916203351864;8604.26863716585;12669.239845609292;12719.9012162993;12807.935960320232;13191.40638671262;1742.7560141580188;1767.6199617082261;1775.4229875290453;1778.413123669199;1860.4139695995718;48608.513914861105;56717.71641141809;56743.71628141833;58084.709576451845;58478.70760646169;9437.858432123523;9720.125188733047;9816.460094694718;9820.45987470696;9891.060349266809;10790.56837726482;10947.83578246311;12434.316112613713;12461.06542009353;21777.455563610718;7436.442266829901;7480.625968701544;7584.08990921093;7629.237076292437;7839.451238413257;6357.300696923335;6390.265119511223;6466.967665161644;6519.837004074841;6525.869482610321;7611.467197296247;7674.9232507674205;7675.081229692577;7680.34717049046;7703.306702396699;2985.8805647773847;2995.670476247611;3025.440293545657;3035.620547431571;3083.1675447629464;809.1301850510724;825.6119623776815;840.2102024097329;850.6682393866397;868.7350358140701;15628.609284767972;16070.43753468623;16079.276432560562;16598.330977791356;16997;830.0951962361055;851.9361047921307;864.9827003459895;868.847951608466;893.9240164585952;8020.719274825353;8671;9182.449053056838;9406.905930940604;9775.51122443875;508792;510468;511833;526306;533017;65212;69266;70125;70188.64905675541;71010.28989710141;1061.2571200159919;1063.98936010642;1066.5627092891878;1081.3079629037422;1087.2986923434341;14122.646933826736;14707;14760.48338308154;14793.852061479247;15178.089314640714;24236.394090147183;29724.554131688474;30611.693883060885;30687.539686905162;30877;36608.45087323745;37930.62069379381;38184;38357.80821095988;40697.79651101726;8361.289290410383;8632.30941524664;8794.912050879666;8797.164269394398;8811.33914956368;10320.329178603366;10389.636362727268;10399.42803145804;15079.623009424851;15721.135337556087;12403.62789116328;12930.547430840252;12955.611331660066;12994.870051299366;13420.463181473022;12301;13022.413991370222;13054.282014488914;13462.326883655582;13586.98097642661;12832.807507887203;12881.935590321988;13766.587002389944;13835.861641383457;13905.16569005863;8712.172343627346;8863.822723545622;8917.866232006654;9317.906820931705;9319.813603728024;13225.338733063116;13790.724185516434;14098.647533811736;14120.50578229757;14160.221187834768 18:42:56 INFO - 2015-11-20 18:42:56,600 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1206.161717606264;1612.5646075559598;1682.806477255116;1702.2425020865712;1724.2154819557095;5843.620164689292;6619.834504137399;6841.452683785297;6844.726210951556;6849.2465828758795;6716.59700417974;6808.148981377328;6834.760783372583;6837.794866154011;6840.110785597878;2085.9269925552608;2108.5572029873747;2109.8523103382768;2109.9894500527475;2112.0601332407086;2099.9685004724943;2119.713838631788;2122.840786940978;2122.8726276423463;2123.3629911026705;2070.3478404302673;2082.094288984289;2087.1859974609915;2100.9684854727193;2102.043570175574;2028.158314299564;2029.147757941668;2030.4822270321047;2031;2031.086011294923;2033.6034473277716;2054.907529161191;2057.238821636004;2059.2792522617115;2078.6362386582437;5655.971720141414;5839.678817665069;6810.829729256759;6846.315368463163;6855.862882742317;3875.205582855508;3965.1276719121747;3967.6032396760093;3968.503937007874;3985.242803867256;2792.581112833091;2802.201372608817;2846.7722582193373;2851.672057713348;2879.6544414670166;914.2777206007246;920.8250432417819;939.9013103624158;943.1370296179057;1753.7632419623314;9135.634574617008;9196.632134714604;9219.585118669676;9250.074992500764;9285.02507236744;3771.4908487354405;3782.394816829294;3812.618738126165;3825;3904.2972264992004;7228.4578656599915;7290.817729556804;7291.817704557322;7298.56208627484;7301.817454563678;4076.0828813516723;4104.610062044161;4111.198316328288;4112.485939257593;4116.135611521614;3802.4106263529197;3806.7715937043313;3810.5998870118237;3818.026403267205;3829.6744776694295;3109.875604975821;3157.2264795124884;3198.504231844068;3209.0854106579513;3223.3553289342226;923.2429407885469;936.3445588088365;943.1700103908654;945.8959514453404;946.6923249943795;1072.5924148823553;1083.247143235444;1096.819024860889;1101.6144349477618;1104.8508451359126;6557.3442655735;6573.704183311763;6598.340165983459;6606.735730570724;6610.669466526654;443.1380964025005;450.40096671426926;453.4558529764296;456.7664122441265;458.191292368969;4786.976065119722;5153.845384638467;5154.793808247703;5209.635325527177;5224.268602395668;7001.579905205704;7998.520088794691;8168.101508834024;8182.1817818217705;8187.754367368989;7982.441229113906;7984.161663025298;8053.59732013397;8060.8387832243025;8068.717594884269;6337.112804207414;6480;6491.967540162269;6524.608523488606;6541.640209788412;6448.709808058742;6487.3188315226225;6491;6507.739690412331;6509.283978762427;7279.381252593377;7380.040594722652;7382.040334756447;7473.215312392121;7493.962530187532;7445.2182520836695;7553.169151393452;7572.318491335806;7650.617469126632;7661.693532258871;5672.858178545569;5679.914801278067;5739.9139012915675;5764.3371012332445;5857.414258574108;6623.304553021863;6629.966850165718;6655.866882662222;6669.666516674244;6678.165229346332;5808.244928159313;6194.101855231056;6238.532110091852;6327.303996560467;6338.334474880071;5982.371850955587;5983.850403739942;6003;6265.4361107500545;6265.937340626535;6084.8783024340155;6323.936760632519;6325;6326.2092238470195;6328.430441260309;5742.052561327334;5780.971095144498;5783.074708046693;5784.971075144597;5787.045137552257;5719.370869204301;5725.6850873202375;5834.445727655866;5913.408659134224;5966.910496342645 18:42:56 INFO - 2015-11-20 18:42:56,603 DEBUG : BROWSER_OUTPUT: |4;prototype.html;309.4414581680067;315.728473512779;317.764854008034;324.4322435737458;325.9168911927458;5336.412994570599;5482.9177562336545;5497.890042199164;5539.667619942807;5541.861453463665;5367.812126575571;5422.2951016367815;5422.701751403672;5437.9939711153365;5438.510534051935;3994.4208089826957;4107.856225032125;4109.630133288004;4201.516825565069;4204.705670603052;4175.457190565222;4190.994161401272;4192.727472714279;4208.473940757405;4212.1575684863;4157.189348077126;4159.958400415987;4161.105362347094;4163.479565054368;4175.331946888498;3944.152007318426;4014.919701605966;4032.7580345179385;4112.753234805921;4171.436856024428;3614.6023937366867;3626.34725749365;3630.8910732678064;3641.9802455312556;3648.963510364889;5163.173892177271;5185.507376799198;5197.402298735656;5201.5838732901275;5207.218917162418;4782.832600858953;4794.976025119852;4801.447833499157;4804.087223427572;4809.182438985381;5531.474509921551;5711.343195532525;5731.512821410185;5747.425257474261;5747.712614369307;3981.6615587675083;3981.7212795104356;3984.960150398517;3986.063275130342;3989.6608788253034;5950;6009.158717779471;6026.60827046245;6030.396960303934;6032.095185722133;4071.2875246831686;4095.4675892133832;4098.73358231714;4101.179764047143;4107.260693075275;4002.2795896738285;4133.565975572522;4142.813573389205;4147.585241475828;4160.8335666573;4736.265878788793;4739.772307015697;4746.43042834862;4752.524747525289;4757.500462451462;5696.686682232434;5697.686627235542;5698.116791897262;5700.8859822803315;5701.315842098975;1432.7850822376727;1456.7086582683505;1457.5481600703815;1458.3874772595323;1459.9197044162672;973.1436336024253;980.3145711741928;983.7442265011006;989.342087511811;1002.2983911262146;5002.399712034579;5005.924911126336;5011.624128190328;5012.724300163453;5014.6991180529285;5897.5871688982215;5911.556633252523;5915.024021036481;5932.40675932412;5946.07835785454;5021.59827213822;5025.396952365666;5027.245913113063;5030.8239211627415;5031.22016087507;3033.2568520712125;3080.5071188609713;3180.3798259339205;3192.4413227685527;3214.8392580370887;5613.831585052455;5634.3802181759975;5661.264035675335;5661.943380566224;5669.206311116447;6152.2924863640355;6153;6154.230721159855;6155.292141403706;6162.291336496271;5454.645448045943;5626.24045753818;5649.519790817744;5650.519705825051;5655.462731040545;5985.790497332572;6004.159417681441;6008.158857760004;6009.248843894513;6012.549058820518;5780.132980053026;5787.363390027178;5824.184614153937;5837.67892765885;5843.341279717633;5540.335159780852;5653.95401850659;5660.575456840836;5664.971675141598;5666.17840413146;4054.2499637567144;4109.137081212859;4113.85601503946;4117.764670598748;4118.897027574335;5965.105234214729;5973.761049557969;5976.073708575178;5978.551608629283;5981.671008094597;5739.9139012915675;5741.16753070794;5746.597738158456;5748.885022299614;5756.165356023437;5593.888122237614;5729;5739.081746920473;5746.942530574641;5748.022836117953;5617.578681598815;5630.18362337467;5633.295838020247;5634.802781902614;5635.267415236157;5767.336756273083;5791;5792.884142317214;5797.043487824631;5798.623089499169;5527.5577953764405;5652.265205523256;5653.123765816305;5656.519195868233;5662.462066103713 18:42:56 INFO - 2015-11-20 18:42:56,605 DEBUG : BROWSER_OUTPUT: |5;yui.html;644.7614382678408;690.0167261652145;732.9157146928098;740.7999840043188;749.2919191364163;10905.727356816084;11120.388378639193;11149.554017839288;11191.048760855327;12581.056420768457;13414.262215578163;13477;13489.46042158315;13507.932460337684;13509;623.3859648246473;628.5254632752266;786.2020049649625;799.7240951871595;805.8670319397293;797.3501596199079;797.8005498625344;800.2557621412085;805.3637626275236;806.4637016384097;831.0816547714779;833.8832563441123;838.3837879158814;839.2279103225047;841.4951029382353;652.9706163222667;661.7485355564903;813.7965508622844;824.295227580416;826.0376661189707;603.846019265089;608.4432744039243;608.4767100293744;608.558794873713;608.7321578505444;11581.76836463266;11745.530178792838;11749.236299640495;11763.117766167572;11763.294202347886;10807.459627018618;10854.565817367296;10974.890251097546;11022.393768342738;11457.255278406878;8885.466871987637;9016.09839016093;9055.230305424047;9135.269178465707;9511.191548718367;3224.3551289742145;3291.687289707474;3297.0273769238133;3299.406106900757;3302.0424077017638;40275.39586906199;40774.388384173966;41057.794711026254;41144.794276028726;41361.79319103415;9355.064493550726;9648.565814538222;9721;9832.360896541702;9842.950785246172;16304.347826087062;16324.591885202964;16345.182740863147;16346.509604711877;16347.754783678254;6318.431341179224;6356.45970092538;6371.23545174582;6419.74321027163;6464.903026454607;3697.1681371691157;3744.3260213161893;3761;3767.05823544114;3779.527559055118;2792.5950737143003;2796.1052463211577;2813.366992426688;2816.8732407041734;2818.689944106147;473.9336492890998;480.0878331170803;481.71819485600616;493.8370337788521;494.2684826456864;462.37810145354445;486.7712175277614;510.27031345176755;538.7306346826587;590.0765302301969;7338.302861228175;7711.228877112244;7793.415493837985;8023.358131349478;8090.514569125871;448.8227150275623;456.68488742767386;476.0265257548322;554.1078863030517;569.3225062175998;3615.8011309378235;3831.207104966119;3853.094522787143;3922.666573341241;3974.2647610192207;52812.471875281524;53354.7332263344;53399.199012014076;53437.46562534325;53437.73281133569;46960;48107.75946120247;48389.516104839204;48452.757736211795;48709.26936095962;43451.78274108609;43685.90785230458;43699.78150109229;44152.558474415484;44409.77795111004;7556.282153195438;7578.621068946641;7829.686812527663;7862.253085956825;7940.682372705027;31265.218369540944;31413.685863141076;32168.83915580407;32201.677983219866;32218.516722248718;39457;41579;41603.583964159974;41682.58317416787;41812.790936046345;9013.954930225307;9260.106636956878;9286.535673216447;9390.201832844285;9491.193248573949;10445.843312350473;10451.693727193897;10528;10547.789044219226;10668.62659806903;9959.601615935282;9983.650572230228;9997.600095996078;9999.150072243941;10059.39643621385;9475.763105922131;9673.70978870635;9801.411915285105;9897.208223341971;9905.356151850106;9938.354006989523;10027.699169024942;10029.44838033886;10033.74915627086;10086.596536138471;8597.355198360023;8884.600192991202;8937.687180948635;8953.418027828171;9060.54697265121;8250.38122140854;8387;8442.36682248846;8636.438631488933;8683.82632347337 18:42:56 INFO - 2015-11-20 18:42:56,605 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:42:56 INFO - 2015-11-20 18:42:56,605 DEBUG : BROWSER_OUTPUT: __start_cc_report 18:42:56 INFO - 2015-11-20 18:42:56,605 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,967 18:42:56 INFO - 2015-11-20 18:42:56,605 DEBUG : BROWSER_OUTPUT: __end_cc_report 18:42:56 INFO - 2015-11-20 18:42:56,605 DEBUG : BROWSER_OUTPUT: __startTimestamp1448073776591__endTimestamp 18:42:56 INFO - 2015-11-20 18:42:56,606 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,606 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:42:56 INFO - 2015-11-20 18:42:56,606 DEBUG : BROWSER_OUTPUT: Number of tests: 6 18:42:56 INFO - 2015-11-20 18:42:56,606 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,606 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4637.90 Median:4755.36 stddev:485.10 (10.2%) stddev-sans-first:460.59 18:42:56 INFO - 2015-11-20 18:42:56,607 DEBUG : BROWSER_OUTPUT: Values: 2640.6 2716.7 2717.6 2737.1 2743.4 4426.2 4552.7 4670.4 4687.6 4695.7 4524.2 4566.7 4576.7 4616.6 4621.2 4285.1 4294.4 4335.6 4446.9 4452.0 4156.1 4328.2 4370.9 4455.6 4481.8 4267.2 4293.6 4301.4 4312.0 4315.2 4313.4 4318.8 4324.3 4325.8 4372.9 4141.7 4215.9 4289.4 4310.7 4355.8 4523.1 4526.4 4614.1 4648.8 4667.9 5045.3 5066.8 5072.6 5078.4 5127.9 4728.9 5074.8 5091.8 5101.6 5115.1 4571.0 4595.8 4608.3 4660.8 4711.9 5186.9 5215.5 5219.5 5222.1 5230.4 4755.4 4997.2 5013.1 5017.4 5060.1 4992.3 5003.8 5019.7 5058.2 5077.2 4956.6 4990.1 4994.6 4998.5 5044.5 4748.2 4951.2 4963.2 4965.3 5008.7 4094.3 4117.0 4131.3 4171.5 4171.7 3691.6 3708.4 3713.2 3745.1 3753.9 4323.7 4358.6 4370.5 4373.6 4406.1 4815.6 4927.0 4928.8 5011.4 5099.2 4346.7 4346.8 4357.7 4365.8 4400.6 4482.4 4483.8 4490.3 4490.5 4528.5 4630.3 4701.6 4759.2 4766.3 4819.5 5070.4 5073.3 5086.8 5090.9 5136.1 4810.9 4819.6 4821.4 4823.9 4858.5 4773.3 4870.8 4872.6 4899.9 5016.0 5049.1 5094.9 5108.7 5110.3 5160.6 4940.6 4946.1 4947.2 4949.9 4952.6 4681.6 4786.3 4800.7 4805.0 4878.6 4868.3 4870.9 4871.1 4882.0 4888.7 4996.2 4996.8 5000.9 5002.7 5016.6 4627.6 4726.5 4777.3 4789.8 4939.4 18:42:56 INFO - 2015-11-20 18:42:56,607 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,607 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:39292.90 Median:16858.26 stddev:59815.61 (354.8%) stddev-sans-first:59912.74 18:42:56 INFO - 2015-11-20 18:42:56,608 DEBUG : BROWSER_OUTPUT: Values: 568.8 574.6 578.6 584.7 584.9 28739.7 29454.9 38532.6 39206.4 39361.0 41964.2 41984.8 42379.4 42530.8 42599.8 7004.8 7859.1 7999.0 8000.1 8021.2 7141.6 10061.9 10272.8 10294.3 10328.3 10073.6 10157.0 10160.2 10165.9 10175.8 7176.1 7392.9 10130.3 10224.2 10315.4 10100.2 10215.0 10255.6 10277.1 10280.9 39804.2 40164.0 40323.2 40349.6 40403.6 2858.3 2883.6 2929.9 3066.0 3373.9 28752.0 29080.0 29171.7 29232.0 29274.6 3469.8 3498.3 3516.1 3549.8 3639.0 223062.0 224027.0 224053.9 224346.0 225257.0 52814.7 54098.5 58255.7 58732.4 58739.0 62192.7 62957.0 63318.4 63385.7 63431.7 12194.8 12329.6 12345.3 12358.8 12359.3 9022.8 9030.5 9047.2 9055.8 9062.2 18718.5 18847.4 18878.0 19700.6 19757.9 7616.0 7807.9 7898.6 7945.8 8030.6 796.2 805.3 860.5 926.4 1008.9 23683.9 26533.7 27362.5 27931.3 28012.4 935.7 940.8 947.3 1026.2 1092.2 12966.0 13352.9 13419.7 13521.4 13755.3 275683.0 278117.0 280939.0 281258.0 282836.0 46702.3 46755.0 46923.0 46958.8 47036.3 1196.0 1224.6 1230.4 1231.8 1245.2 24118.3 24673.6 25317.6 25400.5 25606.0 37026.4 37799.0 41571.0 43724.6 45262.1 169190.0 170792.0 171172.0 171289.0 171473.0 24531.6 28209.4 28483.4 28524.7 28565.0 28227.9 39110.6 39123.6 39493.8 39963.0 31986.7 32821.5 33856.5 34113.0 34547.8 30618.7 30700.2 32013.4 33604.2 34186.7 30650.5 30993.8 31042.7 31327.7 31611.8 26997.2 30364.6 30465.7 30654.4 30657.0 23207.0 23521.4 23634.8 23699.8 23834.9 18:42:56 INFO - 2015-11-20 18:42:56,608 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,608 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:27047.45 Median:38057.31 stddev:84487.44 (222.0%) stddev-sans-first:84700.64 18:42:56 INFO - 2015-11-20 18:42:56,608 DEBUG : BROWSER_OUTPUT: Values: 336.0 339.4 343.5 344.0 347.9 12336.7 12737.4 14834.7 14857.2 15762.9 14632.3 14750.3 15087.8 15192.4 15226.5 4621.2 4700.0 4927.0 5061.9 5069.8 4968.7 5023.4 5025.0 5025.9 5027.2 4862.1 4958.8 4976.7 4989.0 5007.3 4844.7 4845.5 4847.6 4867.3 4893.4 4279.1 4385.5 4387.4 4391.6 4478.7 19247.8 19491.9 19518.4 19518.5 19685.5 1827.9 1999.1 2010.2 2024.4 2094.9 8604.3 12669.2 12719.9 12807.9 13191.4 1742.8 1767.6 1775.4 1778.4 1860.4 48608.5 56717.7 56743.7 58084.7 58478.7 9437.9 9720.1 9816.5 9820.5 9891.1 10790.6 10947.8 12434.3 12461.1 21777.5 7436.4 7480.6 7584.1 7629.2 7839.5 6357.3 6390.3 6467.0 6519.8 6525.9 7611.5 7674.9 7675.1 7680.3 7703.3 2985.9 2995.7 3025.4 3035.6 3083.2 809.1 825.6 840.2 850.7 868.7 15628.6 16070.4 16079.3 16598.3 16997.0 830.1 851.9 865.0 868.8 893.9 8020.7 8671.0 9182.4 9406.9 9775.5 508792.0 510468.0 511833.0 526306.0 533017.0 65212.0 69266.0 70125.0 70188.6 71010.3 1061.3 1064.0 1066.6 1081.3 1087.3 14122.6 14707.0 14760.5 14793.9 15178.1 24236.4 29724.6 30611.7 30687.5 30877.0 36608.5 37930.6 38184.0 38357.8 40697.8 8361.3 8632.3 8794.9 8797.2 8811.3 10320.3 10389.6 10399.4 15079.6 15721.1 12403.6 12930.5 12955.6 12994.9 13420.5 12301.0 13022.4 13054.3 13462.3 13587.0 12832.8 12881.9 13766.6 13835.9 13905.2 8712.2 8863.8 8917.9 9317.9 9319.8 13225.3 13790.7 14098.6 14120.5 14160.2 18:42:56 INFO - 2015-11-20 18:42:56,608 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,608 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4769.71 Median:5841.65 stddev:2423.73 (41.5%) stddev-sans-first:2415.72 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: Values: 1206.2 1612.6 1682.8 1702.2 1724.2 5843.6 6619.8 6841.5 6844.7 6849.2 6716.6 6808.1 6834.8 6837.8 6840.1 2085.9 2108.6 2109.9 2110.0 2112.1 2100.0 2119.7 2122.8 2122.9 2123.4 2070.3 2082.1 2087.2 2101.0 2102.0 2028.2 2029.1 2030.5 2031.0 2031.1 2033.6 2054.9 2057.2 2059.3 2078.6 5656.0 5839.7 6810.8 6846.3 6855.9 3875.2 3965.1 3967.6 3968.5 3985.2 2792.6 2802.2 2846.8 2851.7 2879.7 914.3 920.8 939.9 943.1 1753.8 9135.6 9196.6 9219.6 9250.1 9285.0 3771.5 3782.4 3812.6 3825.0 3904.3 7228.5 7290.8 7291.8 7298.6 7301.8 4076.1 4104.6 4111.2 4112.5 4116.1 3802.4 3806.8 3810.6 3818.0 3829.7 3109.9 3157.2 3198.5 3209.1 3223.4 923.2 936.3 943.2 945.9 946.7 1072.6 1083.2 1096.8 1101.6 1104.9 6557.3 6573.7 6598.3 6606.7 6610.7 443.1 450.4 453.5 456.8 458.2 4787.0 5153.8 5154.8 5209.6 5224.3 7001.6 7998.5 8168.1 8182.2 8187.8 7982.4 7984.2 8053.6 8060.8 8068.7 6337.1 6480.0 6492.0 6524.6 6541.6 6448.7 6487.3 6491.0 6507.7 6509.3 7279.4 7380.0 7382.0 7473.2 7494.0 7445.2 7553.2 7572.3 7650.6 7661.7 5672.9 5679.9 5739.9 5764.3 5857.4 6623.3 6630.0 6655.9 6669.7 6678.2 5808.2 6194.1 6238.5 6327.3 6338.3 5982.4 5983.9 6003.0 6265.4 6265.9 6084.9 6323.9 6325.0 6326.2 6328.4 5742.1 5781.0 5783.1 5785.0 5787.0 5719.4 5725.7 5834.4 5913.4 5966.9 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4741.98 Median:5438.25 stddev:1408.79 (25.9%) stddev-sans-first:1372.90 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: Values: 309.4 315.7 317.8 324.4 325.9 5336.4 5482.9 5497.9 5539.7 5541.9 5367.8 5422.3 5422.7 5438.0 5438.5 3994.4 4107.9 4109.6 4201.5 4204.7 4175.5 4191.0 4192.7 4208.5 4212.2 4157.2 4160.0 4161.1 4163.5 4175.3 3944.2 4014.9 4032.8 4112.8 4171.4 3614.6 3626.3 3630.9 3642.0 3649.0 5163.2 5185.5 5197.4 5201.6 5207.2 4782.8 4795.0 4801.4 4804.1 4809.2 5531.5 5711.3 5731.5 5747.4 5747.7 3981.7 3981.7 3985.0 3986.1 3989.7 5950.0 6009.2 6026.6 6030.4 6032.1 4071.3 4095.5 4098.7 4101.2 4107.3 4002.3 4133.6 4142.8 4147.6 4160.8 4736.3 4739.8 4746.4 4752.5 4757.5 5696.7 5697.7 5698.1 5700.9 5701.3 1432.8 1456.7 1457.5 1458.4 1459.9 973.1 980.3 983.7 989.3 1002.3 5002.4 5005.9 5011.6 5012.7 5014.7 5897.6 5911.6 5915.0 5932.4 5946.1 5021.6 5025.4 5027.2 5030.8 5031.2 3033.3 3080.5 3180.4 3192.4 3214.8 5613.8 5634.4 5661.3 5661.9 5669.2 6152.3 6153.0 6154.2 6155.3 6162.3 5454.6 5626.2 5649.5 5650.5 5655.5 5985.8 6004.2 6008.2 6009.2 6012.5 5780.1 5787.4 5824.2 5837.7 5843.3 5540.3 5654.0 5660.6 5665.0 5666.2 4054.2 4109.1 4113.9 4117.8 4118.9 5965.1 5973.8 5976.1 5978.6 5981.7 5739.9 5741.2 5746.6 5748.9 5756.2 5593.9 5729.0 5739.1 5746.9 5748.0 5617.6 5630.2 5633.3 5634.8 5635.3 5767.3 5791.0 5792.9 5797.0 5798.6 5527.6 5652.3 5653.1 5656.5 5662.5 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12515.45 Median:26661.37 stddev:14669.70 (55.0%) stddev-sans-first:14683.76 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: Values: 644.8 690.0 732.9 740.8 749.3 10905.7 11120.4 11149.6 11191.0 12581.1 13414.3 13477.0 13489.5 13507.9 13509.0 623.4 628.5 786.2 799.7 805.9 797.4 797.8 800.3 805.4 806.5 831.1 833.9 838.4 839.2 841.5 653.0 661.7 813.8 824.3 826.0 603.8 608.4 608.5 608.6 608.7 11581.8 11745.5 11749.2 11763.1 11763.3 10807.5 10854.6 10974.9 11022.4 11457.3 8885.5 9016.1 9055.2 9135.3 9511.2 3224.4 3291.7 3297.0 3299.4 3302.0 40275.4 40774.4 41057.8 41144.8 41361.8 9355.1 9648.6 9721.0 9832.4 9843.0 16304.3 16324.6 16345.2 16346.5 16347.8 6318.4 6356.5 6371.2 6419.7 6464.9 3697.2 3744.3 3761.0 3767.1 3779.5 2792.6 2796.1 2813.4 2816.9 2818.7 473.9 480.1 481.7 493.8 494.3 462.4 486.8 510.3 538.7 590.1 7338.3 7711.2 7793.4 8023.4 8090.5 448.8 456.7 476.0 554.1 569.3 3615.8 3831.2 3853.1 3922.7 3974.3 52812.5 53354.7 53399.2 53437.5 53437.7 46960.0 48107.8 48389.5 48452.8 48709.3 43451.8 43685.9 43699.8 44152.6 44409.8 7556.3 7578.6 7829.7 7862.3 7940.7 31265.2 31413.7 32168.8 32201.7 32218.5 39457.0 41579.0 41603.6 41682.6 41812.8 9014.0 9260.1 9286.5 9390.2 9491.2 10445.8 10451.7 10528.0 10547.8 10668.6 9959.6 9983.7 9997.6 9999.2 10059.4 9475.8 9673.7 9801.4 9897.2 9905.4 9938.4 10027.7 10029.4 10033.7 10086.6 8597.4 8884.6 8937.7 8953.4 9060.5 8250.4 8387.0 8442.4 8636.4 8683.8 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:42:56 INFO - 2015-11-20 18:42:56,610 DEBUG : BROWSER_OUTPUT: 18:42:57 INFO - 2015-11-20 18:42:57,353 INFO : Browser exited with error code: 0 18:42:57 INFO - 2015-11-20 18:42:57,369 INFO : Completed test dromaeo_css (00:18:38) 18:42:57 INFO - 2015-11-20 18:42:57,369 INFO : Starting test kraken 18:42:57 INFO - 2015-11-20 18:42:57,369 DEBUG : operating with platform_type : linux_ 18:42:57 INFO - 2015-11-20 18:42:57,370 INFO : Initialising browser for kraken test... 18:42:57 INFO - 2015-11-20 18:42:57,376 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3Ngobg/profile http://localhost:42867/getInfo.html 18:43:01 INFO - 2015-11-20 18:43:01,619 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:43:01 INFO - 2015-11-20 18:43:01,619 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:43:01 INFO - 2015-11-20 18:43:01,619 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 18:43:01 INFO - 2015-11-20 18:43:01,619 DEBUG : BROWSER_OUTPUT: __metrics 18:43:01 INFO - 2015-11-20 18:43:01,720 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:43:03 INFO - 2015-11-20 18:43:03,046 INFO : Browser initialized. 18:43:03 INFO - 2015-11-20 18:43:03,046 INFO : Running cycle 1/1 for kraken test... 18:43:03 INFO - 2015-11-20 18:43:03,047 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3Ngobg/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:43:15 INFO - 2015-11-20 18:43:15,033 DEBUG : BROWSER_OUTPUT: RSS: Main: 142217216 18:43:15 INFO - 2015-11-20 18:43:15,034 DEBUG : BROWSER_OUTPUT: 18:43:17 INFO - 2015-11-20 18:43:17,674 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42867/tests/kraken/driver.html?testName=audio-beat-detection) 18:43:18 INFO - 2015-11-20 18:43:18,260 DEBUG : BROWSER_OUTPUT: RSS: Main: 175898624 18:43:18 INFO - 2015-11-20 18:43:18,260 DEBUG : BROWSER_OUTPUT: 18:43:20 INFO - 2015-11-20 18:43:20,959 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42867/tests/kraken/driver.html?testName=audio-dft) 18:43:21 INFO - 2015-11-20 18:43:21,532 DEBUG : BROWSER_OUTPUT: RSS: Main: 166510592 18:43:21 INFO - 2015-11-20 18:43:21,532 DEBUG : BROWSER_OUTPUT: 18:43:24 INFO - 2015-11-20 18:43:24,577 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42867/tests/kraken/driver.html?testName=audio-fft) 18:43:25 INFO - 2015-11-20 18:43:25,146 DEBUG : BROWSER_OUTPUT: RSS: Main: 151166976 18:43:25 INFO - 2015-11-20 18:43:25,146 DEBUG : BROWSER_OUTPUT: 18:43:27 INFO - 2015-11-20 18:43:27,178 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42867/tests/kraken/driver.html?testName=audio-oscillator) 18:43:27 INFO - 2015-11-20 18:43:27,751 DEBUG : BROWSER_OUTPUT: RSS: Main: 154112000 18:43:27 INFO - 2015-11-20 18:43:27,752 DEBUG : BROWSER_OUTPUT: 18:43:29 INFO - 2015-11-20 18:43:29,925 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42867/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:43:30 INFO - 2015-11-20 18:43:30,491 DEBUG : BROWSER_OUTPUT: RSS: Main: 155291648 18:43:30 INFO - 2015-11-20 18:43:30,492 DEBUG : BROWSER_OUTPUT: 18:43:33 INFO - 2015-11-20 18:43:33,463 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42867/tests/kraken/driver.html?testName=imaging-darkroom) 18:43:34 INFO - 2015-11-20 18:43:34,037 DEBUG : BROWSER_OUTPUT: RSS: Main: 156102656 18:43:34 INFO - 2015-11-20 18:43:34,037 DEBUG : BROWSER_OUTPUT: 18:43:37 INFO - 2015-11-20 18:43:37,439 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42867/tests/kraken/driver.html?testName=imaging-desaturate) 18:43:38 INFO - 2015-11-20 18:43:38,020 DEBUG : BROWSER_OUTPUT: RSS: Main: 157478912 18:43:38 INFO - 2015-11-20 18:43:38,020 DEBUG : BROWSER_OUTPUT: 18:43:40 INFO - 2015-11-20 18:43:40,852 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42867/tests/kraken/driver.html?testName=json-parse-financial) 18:43:41 INFO - 2015-11-20 18:43:41,437 DEBUG : BROWSER_OUTPUT: RSS: Main: 156356608 18:43:41 INFO - 2015-11-20 18:43:41,437 DEBUG : BROWSER_OUTPUT: 18:43:43 INFO - 2015-11-20 18:43:43,212 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42867/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:43:43 INFO - 2015-11-20 18:43:43,773 DEBUG : BROWSER_OUTPUT: RSS: Main: 162652160 18:43:43 INFO - 2015-11-20 18:43:43,773 DEBUG : BROWSER_OUTPUT: 18:43:45 INFO - 2015-11-20 18:43:45,636 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:43:46 INFO - 2015-11-20 18:43:46,238 DEBUG : BROWSER_OUTPUT: RSS: Main: 161927168 18:43:46 INFO - 2015-11-20 18:43:46,238 DEBUG : BROWSER_OUTPUT: 18:43:48 INFO - 2015-11-20 18:43:48,290 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:43:48 INFO - 2015-11-20 18:43:48,862 DEBUG : BROWSER_OUTPUT: RSS: Main: 172605440 18:43:48 INFO - 2015-11-20 18:43:48,863 DEBUG : BROWSER_OUTPUT: 18:43:51 INFO - 2015-11-20 18:43:51,398 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:43:51 INFO - 2015-11-20 18:43:51,987 DEBUG : BROWSER_OUTPUT: RSS: Main: 177201152 18:43:51 INFO - 2015-11-20 18:43:51,987 DEBUG : BROWSER_OUTPUT: 18:43:54 INFO - 2015-11-20 18:43:54,547 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:43:55 INFO - 2015-11-20 18:43:55,120 DEBUG : BROWSER_OUTPUT: RSS: Main: 177123328 18:43:55 INFO - 2015-11-20 18:43:55,120 DEBUG : BROWSER_OUTPUT: 18:43:56 INFO - 2015-11-20 18:43:56,858 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42867/tests/kraken/driver.html?testName=ai-astar) 18:43:57 INFO - 2015-11-20 18:43:57,108 DEBUG : BROWSER_OUTPUT: RSS: Main: 234172416 18:43:57 INFO - 2015-11-20 18:43:57,108 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,111 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:43:57 INFO - 2015-11-20 18:43:57,111 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |0;ai-astar;111;112;106;112;113;112;102;112;104;112 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;157;130;152;171;132;159;153;133;164;130 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |2;audio-dft;162;162;161;161;162;159;161;162;162;161 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;72;82;91;72;72;72;99;88;73 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;90;124;91;90;90;135;90;91;131 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;109;109;109;109;109;109;110;110;109 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;146;146;146;146;146;146;146;146;146 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;95;96;96;96;96;97;95;96;96 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;71;70;70;69;69;69;70;77;75;68 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;68;68;70;69;69;69;68;68;68 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;81;82;82;81;81;80;81;82;83;82 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;139;124;119;119;125;120;118;125;126;127 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;146;136;146;147;145;135;147;152;147;137 18:43:57 INFO - 2015-11-20 18:43:57,112 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;68;69;69;68;67;68;67;67;69;69 18:43:57 INFO - 2015-11-20 18:43:57,113 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:43:57 INFO - 2015-11-20 18:43:57,113 DEBUG : BROWSER_OUTPUT: __start_cc_report 18:43:57 INFO - 2015-11-20 18:43:57,113 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,978 18:43:57 INFO - 2015-11-20 18:43:57,113 DEBUG : BROWSER_OUTPUT: __end_cc_report 18:43:57 INFO - 2015-11-20 18:43:57,113 DEBUG : BROWSER_OUTPUT: __startTimestamp1448073837109__endTimestamp 18:43:57 INFO - 2015-11-20 18:43:57,113 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: Number of tests: 14 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:109.60 Median:112.00 stddev:4.01 (3.6%) stddev-sans-first:4.22 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: Values: 111.0 112.0 106.0 112.0 113.0 112.0 102.0 112.0 104.0 112.0 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:148.10 Median:155.00 stddev:15.48 (10.0%) stddev-sans-first:16.08 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: Values: 157.0 130.0 152.0 171.0 132.0 159.0 153.0 133.0 164.0 130.0 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.30 Median:162.00 stddev:0.95 (0.6%) stddev-sans-first:0.97 18:43:57 INFO - 2015-11-20 18:43:57,121 DEBUG : BROWSER_OUTPUT: Values: 162.0 162.0 161.0 161.0 162.0 159.0 161.0 162.0 162.0 161.0 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:79.30 Median:77.50 stddev:10.08 (13.0%) stddev-sans-first:10.34 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: Values: 72.0 72.0 82.0 91.0 72.0 72.0 72.0 99.0 88.0 73.0 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:102.30 Median:90.00 stddev:19.30 (21.4%) stddev-sans-first:20.03 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: Values: 91.0 90.0 124.0 91.0 90.0 90.0 135.0 90.0 91.0 131.0 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.30 Median:109.00 stddev:0.48 (0.4%) stddev-sans-first:0.44 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: Values: 110.0 109.0 109.0 109.0 109.0 109.0 109.0 110.0 110.0 109.0 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.00 Median:146.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: Values: 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: Values: 96.0 95.0 96.0 96.0 96.0 96.0 97.0 95.0 96.0 96.0 18:43:57 INFO - 2015-11-20 18:43:57,122 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:70.80 Median:70.00 stddev:2.90 (4.1%) stddev-sans-first:3.07 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: Values: 71.0 70.0 70.0 69.0 69.0 69.0 70.0 77.0 75.0 68.0 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.50 Median:68.50 stddev:0.71 (1.0%) stddev-sans-first:0.73 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 68.0 70.0 69.0 69.0 69.0 68.0 68.0 68.0 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:81.50 Median:82.00 stddev:0.85 (1.0%) stddev-sans-first:0.88 18:43:57 INFO - 2015-11-20 18:43:57,123 DEBUG : BROWSER_OUTPUT: Values: 81.0 82.0 82.0 81.0 81.0 80.0 81.0 82.0 83.0 82.0 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:124.20 Median:125.00 stddev:6.16 (4.9%) stddev-sans-first:3.50 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: Values: 139.0 124.0 119.0 119.0 125.0 120.0 118.0 125.0 126.0 127.0 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.80 Median:146.50 stddev:5.71 (3.9%) stddev-sans-first:6.00 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: Values: 146.0 136.0 146.0 147.0 145.0 135.0 147.0 152.0 147.0 137.0 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: 18:43:57 INFO - 2015-11-20 18:43:57,124 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.10 Median:68.50 stddev:0.88 (1.3%) stddev-sans-first:0.93 18:43:57 INFO - 2015-11-20 18:43:57,125 DEBUG : BROWSER_OUTPUT: Values: 68.0 69.0 69.0 68.0 67.0 68.0 67.0 67.0 69.0 69.0 18:43:57 INFO - 2015-11-20 18:43:57,125 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:43:57 INFO - 2015-11-20 18:43:57,125 DEBUG : BROWSER_OUTPUT: 18:43:58 INFO - 2015-11-20 18:43:58,001 INFO : Browser exited with error code: 0 18:43:58 INFO - 2015-11-20 18:43:58,059 INFO : Completed test kraken (00:01:00) 18:43:58 INFO - 2015-11-20 18:43:58,059 INFO : Starting test v8_7 18:43:58 INFO - 2015-11-20 18:43:58,059 DEBUG : operating with platform_type : linux_ 18:43:58 INFO - 2015-11-20 18:43:58,059 INFO : Initialising browser for v8_7 test... 18:43:58 INFO - 2015-11-20 18:43:58,065 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMyGgAu/profile http://localhost:42867/getInfo.html 18:44:02 INFO - 2015-11-20 18:44:02,261 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:44:02 INFO - 2015-11-20 18:44:02,262 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:44:02 INFO - 2015-11-20 18:44:02,262 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 18:44:02 INFO - 2015-11-20 18:44:02,262 DEBUG : BROWSER_OUTPUT: __metrics 18:44:02 INFO - 2015-11-20 18:44:02,378 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:44:03 INFO - 2015-11-20 18:44:03,735 INFO : Browser initialized. 18:44:03 INFO - 2015-11-20 18:44:03,736 INFO : Running cycle 1/1 for v8_7 test... 18:44:03 INFO - 2015-11-20 18:44:03,736 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMyGgAu/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:44:15 INFO - 2015-11-20 18:44:15,713 DEBUG : BROWSER_OUTPUT: RSS: Main: 141807616 18:44:15 INFO - 2015-11-20 18:44:15,713 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,093 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42867/tests/v8_7/run.html (next: http://localhost:42867/tests/v8_7/run.html) 18:44:37 INFO - 2015-11-20 18:44:37,343 DEBUG : BROWSER_OUTPUT: RSS: Main: 439201792 18:44:37 INFO - 2015-11-20 18:44:37,343 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,343 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:44:37 INFO - 2015-11-20 18:44:37,345 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:44:37 INFO - 2015-11-20 18:44:37,345 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:44:37 INFO - 2015-11-20 18:44:37,345 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:44:37 INFO - 2015-11-20 18:44:37,345 DEBUG : BROWSER_OUTPUT: |0;Richards;162.91951775822744 18:44:37 INFO - 2015-11-20 18:44:37,345 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.93857965451056 18:44:37 INFO - 2015-11-20 18:44:37,345 DEBUG : BROWSER_OUTPUT: |2;Encrypt;279.79854504756577 18:44:37 INFO - 2015-11-20 18:44:37,346 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5030.150753768844 18:44:37 INFO - 2015-11-20 18:44:37,346 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2044.9897750511248 18:44:37 INFO - 2015-11-20 18:44:37,346 DEBUG : BROWSER_OUTPUT: |5;Earley;789.2659826361484 18:44:37 INFO - 2015-11-20 18:44:37,346 DEBUG : BROWSER_OUTPUT: |6;Boyer;12358.024691358025 18:44:37 INFO - 2015-11-20 18:44:37,346 DEBUG : BROWSER_OUTPUT: |7;RegExp;26256.410256410258 18:44:37 INFO - 2015-11-20 18:44:37,346 DEBUG : BROWSER_OUTPUT: |8;Splay;621.5040397762585 18:44:37 INFO - 2015-11-20 18:44:37,347 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4840.579710144928 18:44:37 INFO - 2015-11-20 18:44:37,347 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:44:37 INFO - 2015-11-20 18:44:37,347 DEBUG : BROWSER_OUTPUT: __startTimestamp1448073877343__endTimestamp 18:44:37 INFO - 2015-11-20 18:44:37,347 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,348 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:44:37 INFO - 2015-11-20 18:44:37,348 DEBUG : BROWSER_OUTPUT: Number of tests: 10 18:44:37 INFO - 2015-11-20 18:44:37,348 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,348 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.92 Median:162.92 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,348 DEBUG : BROWSER_OUTPUT: Values: 162.9 18:44:37 INFO - 2015-11-20 18:44:37,348 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,349 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.94 Median:191.94 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,349 DEBUG : BROWSER_OUTPUT: Values: 191.9 18:44:37 INFO - 2015-11-20 18:44:37,349 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,349 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:279.80 Median:279.80 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,349 DEBUG : BROWSER_OUTPUT: Values: 279.8 18:44:37 INFO - 2015-11-20 18:44:37,350 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,350 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5030.15 Median:5030.15 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,350 DEBUG : BROWSER_OUTPUT: Values: 5030.2 18:44:37 INFO - 2015-11-20 18:44:37,350 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,350 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2044.99 Median:2044.99 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,350 DEBUG : BROWSER_OUTPUT: Values: 2045.0 18:44:37 INFO - 2015-11-20 18:44:37,351 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,351 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:789.27 Median:789.27 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,351 DEBUG : BROWSER_OUTPUT: Values: 789.3 18:44:37 INFO - 2015-11-20 18:44:37,351 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,351 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12358.02 Median:12358.02 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,352 DEBUG : BROWSER_OUTPUT: Values: 12358.0 18:44:37 INFO - 2015-11-20 18:44:37,352 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,352 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26256.41 Median:26256.41 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,352 DEBUG : BROWSER_OUTPUT: Values: 26256.4 18:44:37 INFO - 2015-11-20 18:44:37,352 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,352 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:621.50 Median:621.50 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,353 DEBUG : BROWSER_OUTPUT: Values: 621.5 18:44:37 INFO - 2015-11-20 18:44:37,353 DEBUG : BROWSER_OUTPUT: 18:44:37 INFO - 2015-11-20 18:44:37,353 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 18:44:37 INFO - 2015-11-20 18:44:37,353 DEBUG : BROWSER_OUTPUT: Values: 4840.6 18:44:37 INFO - 2015-11-20 18:44:37,353 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:44:37 INFO - 2015-11-20 18:44:37,354 DEBUG : BROWSER_OUTPUT: 18:44:38 INFO - 2015-11-20 18:44:38,293 INFO : Browser exited with error code: 0 18:44:38 INFO - 2015-11-20 18:44:38,307 INFO : Completed test v8_7 (00:00:40) 18:44:38 INFO - 2015-11-20 18:44:38,393 INFO : Completed test suite (00:20:19) 18:44:38 INFO - 2015-11-20 18:44:38,393 DEBUG : Working with test: dromaeo_css 18:44:38 INFO - 2015-11-20 18:44:38,393 DEBUG : Generating results file: dromaeo_css 18:44:38 INFO - 2015-11-20 18:44:38,394 DEBUG : Working with test: kraken 18:44:38 INFO - 2015-11-20 18:44:38,394 DEBUG : Generating results file: kraken 18:44:38 INFO - 2015-11-20 18:44:38,395 INFO : javascript benchmark 18:44:38 INFO - 2015-11-20 18:44:38,395 DEBUG : Working with test: v8_7 18:44:38 INFO - 2015-11-20 18:44:38,395 DEBUG : Generating results file: v8_7 18:44:38 INFO - 2015-11-20 18:44:38,395 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:44:38 INFO - 2015-11-20 18:44:38,455 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,203,35]] 18:44:38 INFO - 2015-11-20 18:44:38,455 DEBUG : process_Request line: dromaeo_css 6312.17 graph.html#tests=[[72,203,35]] 18:44:38 INFO - 2015-11-20 18:44:38,455 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:44:38 INFO - 2015-11-20 18:44:38,501 DEBUG : process_Request line: kraken 1508.70 graph.html#tests=[[232,203,35]] 18:44:38 INFO - 2015-11-20 18:44:38,501 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:44:38 INFO - 2015-11-20 18:44:38,531 DEBUG : process_Request line: v8_7 19737.61 graph.html#tests=[[230,203,35]] 18:44:38 INFO - 2015-11-20 18:44:38,532 INFO : javascript benchmark 18:44:38 INFO - 2015-11-20 18:44:38,536 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2640.6171105189746, 2716.701162872084, 2717.605947137664, 2737.1378015924984, 2743.4238809849926, 4426.159029784339, 4552.726836389819, 4670.369500117483, 4687.624990000801, 4695.741734204622, 4524.208263553873, 4566.748828814422, 4576.725396476214, 4616.607588354986, 4621.168189725848, 4285.121550082225, 4294.441722576069, 4335.588119128678, 4446.911061778763, 4452.0, 4156.085661154541, 4328.242557552431, 4370.907273181705, 4455.643548516127, 4481.753503557303, 4267.231898258312, 4293.570642935712, 4301.419308393358, 4311.956880431187, 4315.244832154361, 4313.352997050436, 4318.784060796979, 4324.329728892027, 4325.805338759732, 4372.934405983913, 4141.730787498803, 4215.915681686349, 4289.442372491588, 4310.698251122422, 4355.825766969318, 4523.050159466516, 4526.411566496367, 4614.123316569841, 4648.767561621906, 4667.859964201046, 5045.268436076785, 5066.771995260222, 5072.644914855961, 5078.4159821620615, 5127.9230811537855, 4728.929066064012, 5074.82238121664, 5091.79632814687, 5101.6173786965755, 5115.104856650071, 4571.017231295287, 4595.839145629887, 4608.262677971542, 4660.790264438108, 4711.929321060187, 5186.92219616706, 5215.452377500308, 5219.478052194826, 5222.060029194781, 5230.3985041719925, 4755.358026666425, 4997.150484417658, 5013.1227035268685, 5017.422996355393, 5060.089183946925, 4992.326035985096, 5003.849884503471, 5019.698818070928, 5058.241263810458, 5077.162268225701, 4956.553910148032, 4990.051890140934, 4994.625403094782, 4998.450170481244, 5044.54599086084, 4748.19280722278, 4951.207806750903, 4963.181075122564, 4965.280034394992, 5008.749562521859, 4094.2630326541507, 4116.958830411718, 4131.277026520347, 4171.478565179353, 4171.687123465752, 3691.593924668338, 3708.351038568294, 3713.164537978933, 3745.1198968242443, 3753.887383378503, 4323.718958267703, 4358.607725304674, 4370.497392799805, 4373.606375426163, 4406.1187762447635, 4815.566599006036, 4926.950730492721, 4928.827491037797, 5011.448740638527, 5099.158638824627, 4346.673999450054, 4346.847860324873, 4357.716748411343, 4365.781710914505, 4400.559944005638, 4482.372467854503, 4483.820647174077, 4490.3040028795585, 4490.50604433512, 4528.5245049270015, 4630.3286023525725, 4701.5768580826525, 4759.2147295697205, 4766.308885211694, 4819.518048195152, 5070.391553013515, 5073.289739436408, 5086.7710953007945, 5090.872728181677, 5136.1268584340005, 4810.869445680192, 4819.638527110411, 4821.421429428491, 4823.927641085316, 4858.489858564941, 4773.284007398918, 4870.829520966891, 4872.561469467765, 4899.877503062452, 5016.0, 5049.065922804293, 5094.872628184325, 5108.7445627717725, 5110.284560161655, 5160.561352285098, 4940.580050695731, 4946.134426475424, 4947.158982972831, 4949.901001980013, 4952.628552858622, 4681.625469962327, 4786.2581299898575, 4800.73595952226, 4804.95195048045, 4878.5853202476765, 4868.3427737255015, 4870.878228044327, 4871.123197824426, 4881.9511804881495, 4888.706677599355, 4996.175631020841, 4996.825111121093, 5000.874978125576, 5002.674826136289, 5016.648834581691, 4627.6066534344955, 4726.456457507431, 4777.283407488904, 4789.760511974457, 4939.357883475125], "unit": "ms", "name": "dojo.html", "value": 4608.043906885735}, {"lowerIsBetter": false, "replicates": [568.832194502622, 574.6207503047988, 578.6181120460496, 584.7427132061893, 584.9356570777214, 28739.712602873966, 29454.852725736368, 38532.614673853255, 39206.41190382146, 39361.0, 41964.16071678565, 41984.790076049576, 42379.364309535384, 42530.787346063305, 42599.78700106503, 7004.754833580826, 7859.096203936549, 7999.0, 8000.079990801074, 8021.19788021199, 7141.642917854112, 10061.949690251538, 10272.845907311395, 10294.279400441972, 10328.27702060856, 10073.597056117747, 10157.035081667267, 10160.237982151331, 10165.898341016606, 10175.84736228957, 7176.138863336381, 7392.926070739331, 10130.29087963839, 10224.182065434747, 10315.43265120418, 10100.191984641211, 10215.0, 10255.641052563124, 10277.126444252248, 10280.948595256976, 39804.20391592181, 40164.0, 40323.19353612941, 40349.596504034875, 40403.59596404028, 2858.256853218178, 2883.596296518489, 2929.9267518312, 3065.984670076635, 3373.9156521086925, 28751.990495539732, 29080.0, 29171.708282917323, 29232.0, 29274.560881586793, 3469.757117001811, 3498.2828520153307, 3516.085817687394, 3549.7515173937836, 3639.0, 223062.0, 224027.0, 224053.87973060194, 224346.0, 225257.0, 52814.73592632089, 54098.45901541013, 58255.70872145697, 58732.41267587355, 58739.0, 62192.689036555435, 62957.0, 63318.36681633125, 63385.683071584346, 63431.6828415855, 12194.81707774384, 12329.630111096501, 12345.259284442962, 12358.814617780741, 12359.32023738703, 9022.774430639287, 9030.45817250967, 9047.230985366186, 9055.81888362229, 9062.184403403593, 18718.53203669919, 18847.434576962714, 18878.0, 19700.60598788016, 19757.901210494143, 7615.961920190363, 7807.921920780833, 7898.60506974649, 7945.801354966172, 8030.558319292495, 796.2475460689708, 805.3275514945086, 860.5267103093273, 926.3885835348638, 1008.8789345278467, 23683.881580592333, 26533.734662653125, 27362.45275094487, 27931.301717457227, 28012.439751204864, 935.7473482159779, 940.8118376324762, 947.2942657719905, 1026.2149455666422, 1092.2354351953663, 12966.027547933943, 13352.933235333761, 13419.731605367839, 13521.391537380841, 13755.31223438824, 275683.0, 278117.0, 280939.0, 281258.0, 282836.0, 46702.29946550805, 46755.0, 46923.0, 46958.76520617375, 47036.29445558319, 1195.9701007474882, 1224.6142465123635, 1230.4340003598265, 1231.759806837676, 1245.2404033539533, 24118.276451705777, 24673.62989555194, 25317.620235696846, 25400.491990160463, 25606.0, 37026.444603330434, 37799.0, 41571.0, 43724.56275437205, 45262.094758103995, 169190.0, 170792.0, 171172.0, 171289.0, 171473.0, 24531.63202551999, 28209.43581128407, 28483.43033139367, 28524.714752852207, 28565.0, 28227.858860706387, 39110.6088939107, 39123.608763911994, 39493.80253098716, 39963.0, 31986.68013319837, 32821.507677385336, 33856.49215261724, 34113.0, 34547.82726086454, 30618.693813061585, 30700.232494187825, 32013.35973280568, 33604.1598960028, 34186.65813341835, 30650.540241896837, 30993.8450307747, 31042.68957310398, 31327.68672313339, 31611.84194079107, 26997.1900842975, 30364.55053428084, 30465.695343046285, 30654.386912261183, 30657.0, 23207.0, 23521.411964700335, 23634.763652363257, 23699.763002370444, 23834.927428265422], "unit": "ms", "name": "ext.html", "value": 17042.45315017504}, {"lowerIsBetter": false, "replicates": [335.9932801343973, 339.3772427595362, 343.54651859545396, 344.03498187583835, 347.9234568394952, 12336.691582710437, 12737.42681579329, 14834.703305933876, 14857.182854942974, 15762.921185394085, 14632.268386580681, 14750.33623486943, 15087.773683394731, 15192.392304307841, 15226.467073652424, 4621.214393553088, 4700.012997270577, 4926.9753651231695, 5061.924071138936, 5069.847904562869, 4968.70187788732, 5023.3971923369245, 5024.974875125619, 5025.899482010358, 5027.245913113025, 4862.149123903303, 4958.752062396884, 4976.701397916118, 4989.0, 5007.298978143063, 4844.709317440947, 4845.515448455161, 4847.636427267969, 4867.269909513584, 4893.412790465131, 4279.101388708344, 4385.47374315081, 4387.429634147572, 4391.5827996340295, 4478.664100192498, 19247.80752192474, 19491.90254048735, 19518.414447566454, 19518.51203719904, 19685.50786230356, 1827.9360222392152, 1999.100404817838, 2010.2160157538572, 2024.3926821953503, 2094.916203351864, 8604.26863716585, 12669.239845609292, 12719.9012162993, 12807.935960320232, 13191.40638671262, 1742.7560141580188, 1767.6199617082261, 1775.4229875290453, 1778.413123669199, 1860.4139695995718, 48608.513914861105, 56717.71641141809, 56743.71628141833, 58084.709576451845, 58478.70760646169, 9437.858432123523, 9720.125188733047, 9816.460094694718, 9820.45987470696, 9891.060349266809, 10790.56837726482, 10947.83578246311, 12434.316112613713, 12461.06542009353, 21777.455563610718, 7436.442266829901, 7480.625968701544, 7584.08990921093, 7629.237076292437, 7839.451238413257, 6357.300696923335, 6390.265119511223, 6466.967665161644, 6519.837004074841, 6525.869482610321, 7611.467197296247, 7674.9232507674205, 7675.081229692577, 7680.34717049046, 7703.306702396699, 2985.8805647773847, 2995.670476247611, 3025.440293545657, 3035.620547431571, 3083.1675447629464, 809.1301850510724, 825.6119623776815, 840.2102024097329, 850.6682393866397, 868.7350358140701, 15628.609284767972, 16070.43753468623, 16079.276432560562, 16598.330977791356, 16997.0, 830.0951962361055, 851.9361047921307, 864.9827003459895, 868.847951608466, 893.9240164585952, 8020.719274825353, 8671.0, 9182.449053056838, 9406.905930940604, 9775.51122443875, 508792.0, 510468.0, 511833.0, 526306.0, 533017.0, 65212.0, 69266.0, 70125.0, 70188.64905675541, 71010.28989710141, 1061.2571200159919, 1063.98936010642, 1066.5627092891878, 1081.3079629037422, 1087.2986923434341, 14122.646933826736, 14707.0, 14760.48338308154, 14793.852061479247, 15178.089314640714, 24236.394090147183, 29724.554131688474, 30611.693883060885, 30687.539686905162, 30877.0, 36608.45087323745, 37930.62069379381, 38184.0, 38357.80821095988, 40697.79651101726, 8361.289290410383, 8632.30941524664, 8794.912050879666, 8797.164269394398, 8811.33914956368, 10320.329178603366, 10389.636362727268, 10399.42803145804, 15079.623009424851, 15721.135337556087, 12403.62789116328, 12930.547430840252, 12955.611331660066, 12994.870051299366, 13420.463181473022, 12301.0, 13022.413991370222, 13054.282014488914, 13462.326883655582, 13586.98097642661, 12832.807507887203, 12881.935590321988, 13766.587002389944, 13835.861641383457, 13905.16569005863, 8712.172343627346, 8863.822723545622, 8917.866232006654, 9317.906820931705, 9319.813603728024, 13225.338733063116, 13790.724185516434, 14098.647533811736, 14120.50578229757, 14160.221187834768], "unit": "ms", "name": "jquery.html", "value": 8486.227290214054}, {"lowerIsBetter": false, "replicates": [1206.161717606264, 1612.5646075559598, 1682.806477255116, 1702.2425020865712, 1724.2154819557095, 5843.620164689292, 6619.834504137399, 6841.452683785297, 6844.726210951556, 6849.2465828758795, 6716.59700417974, 6808.148981377328, 6834.760783372583, 6837.794866154011, 6840.110785597878, 2085.9269925552608, 2108.5572029873747, 2109.8523103382768, 2109.9894500527475, 2112.0601332407086, 2099.9685004724943, 2119.713838631788, 2122.840786940978, 2122.8726276423463, 2123.3629911026705, 2070.3478404302673, 2082.094288984289, 2087.1859974609915, 2100.9684854727193, 2102.043570175574, 2028.158314299564, 2029.147757941668, 2030.4822270321047, 2031.0, 2031.086011294923, 2033.6034473277716, 2054.907529161191, 2057.238821636004, 2059.2792522617115, 2078.6362386582437, 5655.971720141414, 5839.678817665069, 6810.829729256759, 6846.315368463163, 6855.862882742317, 3875.205582855508, 3965.1276719121747, 3967.6032396760093, 3968.503937007874, 3985.242803867256, 2792.581112833091, 2802.201372608817, 2846.7722582193373, 2851.672057713348, 2879.6544414670166, 914.2777206007246, 920.8250432417819, 939.9013103624158, 943.1370296179057, 1753.7632419623314, 9135.634574617008, 9196.632134714604, 9219.585118669676, 9250.074992500764, 9285.02507236744, 3771.4908487354405, 3782.394816829294, 3812.618738126165, 3825.0, 3904.2972264992004, 7228.4578656599915, 7290.817729556804, 7291.817704557322, 7298.56208627484, 7301.817454563678, 4076.0828813516723, 4104.610062044161, 4111.198316328288, 4112.485939257593, 4116.135611521614, 3802.4106263529197, 3806.7715937043313, 3810.5998870118237, 3818.026403267205, 3829.6744776694295, 3109.875604975821, 3157.2264795124884, 3198.504231844068, 3209.0854106579513, 3223.3553289342226, 923.2429407885469, 936.3445588088365, 943.1700103908654, 945.8959514453404, 946.6923249943795, 1072.5924148823553, 1083.247143235444, 1096.819024860889, 1101.6144349477618, 1104.8508451359126, 6557.3442655735, 6573.704183311763, 6598.340165983459, 6606.735730570724, 6610.669466526654, 443.1380964025005, 450.40096671426926, 453.4558529764296, 456.7664122441265, 458.191292368969, 4786.976065119722, 5153.845384638467, 5154.793808247703, 5209.635325527177, 5224.268602395668, 7001.579905205704, 7998.520088794691, 8168.101508834024, 8182.1817818217705, 8187.754367368989, 7982.441229113906, 7984.161663025298, 8053.59732013397, 8060.8387832243025, 8068.717594884269, 6337.112804207414, 6480.0, 6491.967540162269, 6524.608523488606, 6541.640209788412, 6448.709808058742, 6487.3188315226225, 6491.0, 6507.739690412331, 6509.283978762427, 7279.381252593377, 7380.040594722652, 7382.040334756447, 7473.215312392121, 7493.962530187532, 7445.2182520836695, 7553.169151393452, 7572.318491335806, 7650.617469126632, 7661.693532258871, 5672.858178545569, 5679.914801278067, 5739.9139012915675, 5764.3371012332445, 5857.414258574108, 6623.304553021863, 6629.966850165718, 6655.866882662222, 6669.666516674244, 6678.165229346332, 5808.244928159313, 6194.101855231056, 6238.532110091852, 6327.303996560467, 6338.334474880071, 5982.371850955587, 5983.850403739942, 6003.0, 6265.4361107500545, 6265.937340626535, 6084.8783024340155, 6323.936760632519, 6325.0, 6326.2092238470195, 6328.430441260309, 5742.052561327334, 5780.971095144498, 5783.074708046693, 5784.971075144597, 5787.045137552257, 5719.370869204301, 5725.6850873202375, 5834.445727655866, 5913.408659134224, 5966.910496342645], "unit": "ms", "name": "mootools.html", "value": 3904.5307212927164}, {"lowerIsBetter": false, "replicates": [309.4414581680067, 315.728473512779, 317.764854008034, 324.4322435737458, 325.9168911927458, 5336.412994570599, 5482.9177562336545, 5497.890042199164, 5539.667619942807, 5541.861453463665, 5367.812126575571, 5422.2951016367815, 5422.701751403672, 5437.9939711153365, 5438.510534051935, 3994.4208089826957, 4107.856225032125, 4109.630133288004, 4201.516825565069, 4204.705670603052, 4175.457190565222, 4190.994161401272, 4192.727472714279, 4208.473940757405, 4212.1575684863, 4157.189348077126, 4159.958400415987, 4161.105362347094, 4163.479565054368, 4175.331946888498, 3944.152007318426, 4014.919701605966, 4032.7580345179385, 4112.753234805921, 4171.436856024428, 3614.6023937366867, 3626.34725749365, 3630.8910732678064, 3641.9802455312556, 3648.963510364889, 5163.173892177271, 5185.507376799198, 5197.402298735656, 5201.5838732901275, 5207.218917162418, 4782.832600858953, 4794.976025119852, 4801.447833499157, 4804.087223427572, 4809.182438985381, 5531.474509921551, 5711.343195532525, 5731.512821410185, 5747.425257474261, 5747.712614369307, 3981.6615587675083, 3981.7212795104356, 3984.960150398517, 3986.063275130342, 3989.6608788253034, 5950.0, 6009.158717779471, 6026.60827046245, 6030.396960303934, 6032.095185722133, 4071.2875246831686, 4095.4675892133832, 4098.73358231714, 4101.179764047143, 4107.260693075275, 4002.2795896738285, 4133.565975572522, 4142.813573389205, 4147.585241475828, 4160.8335666573, 4736.265878788793, 4739.772307015697, 4746.43042834862, 4752.524747525289, 4757.500462451462, 5696.686682232434, 5697.686627235542, 5698.116791897262, 5700.8859822803315, 5701.315842098975, 1432.7850822376727, 1456.7086582683505, 1457.5481600703815, 1458.3874772595323, 1459.9197044162672, 973.1436336024253, 980.3145711741928, 983.7442265011006, 989.342087511811, 1002.2983911262146, 5002.399712034579, 5005.924911126336, 5011.624128190328, 5012.724300163453, 5014.6991180529285, 5897.5871688982215, 5911.556633252523, 5915.024021036481, 5932.40675932412, 5946.07835785454, 5021.59827213822, 5025.396952365666, 5027.245913113063, 5030.8239211627415, 5031.22016087507, 3033.2568520712125, 3080.5071188609713, 3180.3798259339205, 3192.4413227685527, 3214.8392580370887, 5613.831585052455, 5634.3802181759975, 5661.264035675335, 5661.943380566224, 5669.206311116447, 6152.2924863640355, 6153.0, 6154.230721159855, 6155.292141403706, 6162.291336496271, 5454.645448045943, 5626.24045753818, 5649.519790817744, 5650.519705825051, 5655.462731040545, 5985.790497332572, 6004.159417681441, 6008.158857760004, 6009.248843894513, 6012.549058820518, 5780.132980053026, 5787.363390027178, 5824.184614153937, 5837.67892765885, 5843.341279717633, 5540.335159780852, 5653.95401850659, 5660.575456840836, 5664.971675141598, 5666.17840413146, 4054.2499637567144, 4109.137081212859, 4113.85601503946, 4117.764670598748, 4118.897027574335, 5965.105234214729, 5973.761049557969, 5976.073708575178, 5978.551608629283, 5981.671008094597, 5739.9139012915675, 5741.16753070794, 5746.597738158456, 5748.885022299614, 5756.165356023437, 5593.888122237614, 5729.0, 5739.081746920473, 5746.942530574641, 5748.022836117953, 5617.578681598815, 5630.18362337467, 5633.295838020247, 5634.802781902614, 5635.267415236157, 5767.336756273083, 5791.0, 5792.884142317214, 5797.043487824631, 5798.623089499169, 5527.5577953764405, 5652.265205523256, 5653.123765816305, 5656.519195868233, 5662.462066103713], "unit": "ms", "name": "prototype.html", "value": 4291.193623802361}, {"lowerIsBetter": false, "replicates": [644.7614382678408, 690.0167261652145, 732.9157146928098, 740.7999840043188, 749.2919191364163, 10905.727356816084, 11120.388378639193, 11149.554017839288, 11191.048760855327, 12581.056420768457, 13414.262215578163, 13477.0, 13489.46042158315, 13507.932460337684, 13509.0, 623.3859648246473, 628.5254632752266, 786.2020049649625, 799.7240951871595, 805.8670319397293, 797.3501596199079, 797.8005498625344, 800.2557621412085, 805.3637626275236, 806.4637016384097, 831.0816547714779, 833.8832563441123, 838.3837879158814, 839.2279103225047, 841.4951029382353, 652.9706163222667, 661.7485355564903, 813.7965508622844, 824.295227580416, 826.0376661189707, 603.846019265089, 608.4432744039243, 608.4767100293744, 608.558794873713, 608.7321578505444, 11581.76836463266, 11745.530178792838, 11749.236299640495, 11763.117766167572, 11763.294202347886, 10807.459627018618, 10854.565817367296, 10974.890251097546, 11022.393768342738, 11457.255278406878, 8885.466871987637, 9016.09839016093, 9055.230305424047, 9135.269178465707, 9511.191548718367, 3224.3551289742145, 3291.687289707474, 3297.0273769238133, 3299.406106900757, 3302.0424077017638, 40275.39586906199, 40774.388384173966, 41057.794711026254, 41144.794276028726, 41361.79319103415, 9355.064493550726, 9648.565814538222, 9721.0, 9832.360896541702, 9842.950785246172, 16304.347826087062, 16324.591885202964, 16345.182740863147, 16346.509604711877, 16347.754783678254, 6318.431341179224, 6356.45970092538, 6371.23545174582, 6419.74321027163, 6464.903026454607, 3697.1681371691157, 3744.3260213161893, 3761.0, 3767.05823544114, 3779.527559055118, 2792.5950737143003, 2796.1052463211577, 2813.366992426688, 2816.8732407041734, 2818.689944106147, 473.9336492890998, 480.0878331170803, 481.71819485600616, 493.8370337788521, 494.2684826456864, 462.37810145354445, 486.7712175277614, 510.27031345176755, 538.7306346826587, 590.0765302301969, 7338.302861228175, 7711.228877112244, 7793.415493837985, 8023.358131349478, 8090.514569125871, 448.8227150275623, 456.68488742767386, 476.0265257548322, 554.1078863030517, 569.3225062175998, 3615.8011309378235, 3831.207104966119, 3853.094522787143, 3922.666573341241, 3974.2647610192207, 52812.471875281524, 53354.7332263344, 53399.199012014076, 53437.46562534325, 53437.73281133569, 46960.0, 48107.75946120247, 48389.516104839204, 48452.757736211795, 48709.26936095962, 43451.78274108609, 43685.90785230458, 43699.78150109229, 44152.558474415484, 44409.77795111004, 7556.282153195438, 7578.621068946641, 7829.686812527663, 7862.253085956825, 7940.682372705027, 31265.218369540944, 31413.685863141076, 32168.83915580407, 32201.677983219866, 32218.516722248718, 39457.0, 41579.0, 41603.583964159974, 41682.58317416787, 41812.790936046345, 9013.954930225307, 9260.106636956878, 9286.535673216447, 9390.201832844285, 9491.193248573949, 10445.843312350473, 10451.693727193897, 10528.0, 10547.789044219226, 10668.62659806903, 9959.601615935282, 9983.650572230228, 9997.600095996078, 9999.150072243941, 10059.39643621385, 9475.763105922131, 9673.70978870635, 9801.411915285105, 9897.208223341971, 9905.356151850106, 9938.354006989523, 10027.699169024942, 10029.44838033886, 10033.74915627086, 10086.596536138471, 8597.355198360023, 8884.600192991202, 8937.687180948635, 8953.418027828171, 9060.54697265121, 8250.38122140854, 8387.0, 8442.36682248846, 8636.438631488933, 8683.82632347337], "unit": "ms", "name": "yui.html", "value": 5663.882141554632}], "name": "dromaeo_css", "value": 6312.169047700506}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 112.0, 106.0, 112.0, 113.0, 112.0, 102.0, 112.0, 104.0, 112.0], "unit": "ms", "name": "ai-astar", "value": 109.6}, {"lowerIsBetter": true, "replicates": [157.0, 130.0, 152.0, 171.0, 132.0, 159.0, 153.0, 133.0, 164.0, 130.0], "unit": "ms", "name": "audio-beat-detection", "value": 148.1}, {"lowerIsBetter": true, "replicates": [162.0, 162.0, 161.0, 161.0, 162.0, 159.0, 161.0, 162.0, 162.0, 161.0], "unit": "ms", "name": "audio-dft", "value": 161.3}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 82.0, 91.0, 72.0, 72.0, 72.0, 99.0, 88.0, 73.0], "unit": "ms", "name": "audio-fft", "value": 79.3}, {"lowerIsBetter": true, "replicates": [91.0, 90.0, 124.0, 91.0, 90.0, 90.0, 135.0, 90.0, 91.0, 131.0], "unit": "ms", "name": "audio-oscillator", "value": 102.3}, {"lowerIsBetter": true, "replicates": [110.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 110.0, 110.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.3}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0], "unit": "ms", "name": "imaging-darkroom", "value": 146.0}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 97.0, 95.0, 96.0, 96.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.9}, {"lowerIsBetter": true, "replicates": [71.0, 70.0, 70.0, 69.0, 69.0, 69.0, 70.0, 77.0, 75.0, 68.0], "unit": "ms", "name": "json-parse-financial", "value": 70.8}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 68.0, 70.0, 69.0, 69.0, 69.0, 68.0, 68.0, 68.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 68.5}, {"lowerIsBetter": true, "replicates": [81.0, 82.0, 82.0, 81.0, 81.0, 80.0, 81.0, 82.0, 83.0, 82.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 81.5}, {"lowerIsBetter": true, "replicates": [139.0, 124.0, 119.0, 119.0, 125.0, 120.0, 118.0, 125.0, 126.0, 127.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 124.2}, {"lowerIsBetter": true, "replicates": [146.0, 136.0, 146.0, 147.0, 145.0, 135.0, 147.0, 152.0, 147.0, 137.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 143.8}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 69.0, 68.0, 67.0, 68.0, 67.0, 67.0, 69.0, 69.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 68.1}], "name": "kraken", "value": 1508.6999999999998}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [162.91951775822744], "unit": "score", "name": "Richards", "value": 216.6836759999999}, {"lowerIsBetter": false, "replicates": [191.93857965451056], "unit": "score", "name": "DeltaBlue", "value": 344.4747799999999}, {"lowerIsBetter": false, "replicates": [279.79854504756577], "unit": "score", "name": "Encrypt", "value": 951.330894}, {"lowerIsBetter": false, "replicates": [5030.150753768844], "unit": "score", "name": "Decrypt", "value": 52.91710189810189}, {"lowerIsBetter": false, "replicates": [2044.9897750511248], "unit": "score", "name": "RayTrace", "value": 361.85462099999995}, {"lowerIsBetter": false, "replicates": [789.2659826361484], "unit": "score", "name": "Earley", "value": 844.4086210000003}, {"lowerIsBetter": false, "replicates": [12358.024691358025], "unit": "score", "name": "Boyer", "value": 53.929573426573455}, {"lowerIsBetter": false, "replicates": [26256.410256410258], "unit": "score", "name": "RegExp", "value": 34.69571777343749}, {"lowerIsBetter": false, "replicates": [621.5040397762585], "unit": "score", "name": "Splay", "value": 131.11901899999998}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 19737.61449261433}]} 18:44:38 INFO - RETURN: dromaeo_css: 6312.17 18:44:38 INFO - RETURN: kraken: 1508.70 18:44:38 INFO - RETURN: v8_7: 19737.61 18:44:38 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,203,35]]", "result": "19737.61"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,203,35]]", "result": "1508.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,203,35]]", "result": "6312.17"}}} 18:44:38 INFO - Return code: 0 18:44:38 INFO - # TBPL SUCCESS # 18:44:38 INFO - Running post-action listener: _resource_record_post_action 18:44:38 INFO - Running post-run listener: _resource_record_post_run 18:44:39 INFO - Total resource usage - Wall time: 1234s; CPU: 13.0%; Read bytes: 4096; Write bytes: 509042688; Read time: 32; Write time: 538428 18:44:39 INFO - install - Wall time: 14s; CPU: 15.0%; Read bytes: 0; Write bytes: 224821248; Read time: 0; Write time: 277336 18:44:39 INFO - run-tests - Wall time: 1220s; CPU: 13.0%; Read bytes: 0; Write bytes: 276156416; Read time: 0; Write time: 223436 18:44:39 INFO - Running post-run listener: _upload_blobber_files 18:44:39 INFO - Blob upload gear active. 18:44:39 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 18:44:39 INFO - Copying logs to upload dir... 18:44:39 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1263.538256 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2015-11-20 18:44:39.662781) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-20 18:44:39.666540) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010029 build_url: 'https://queue.taskcluster.net/v1/task/mVf6j_jvSkmR1G34kgzQeA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-20 18:44:39.718501) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:44:39.718850) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=447a3abc0420b6a47dd38cba000001bf-1448071238.901958-1389403717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004484 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 18:44:39.769138) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-20 18:44:39.769472) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-20 18:44:39.769765) ========= ========= Total master_lag: 0.24 =========