builder: mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s slave: talos-linux64-ix-076 starttime: 1495484483.01 results: success (0) revision: 8f4d2d35cb317235f30f4e3738ad3df16d2f9f3f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.005302) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.005687) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.005973) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.021410) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.021809) ========= 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=9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-22 13:21:24-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.1M=0s 2017-05-22 13:21:24 (46.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.125316 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.160013) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.160326) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', '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=9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015242 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.212402) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:23.215743) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 8f4d2d35cb317235f30f4e3738ad3df16d2f9f3f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 8f4d2d35cb317235f30f4e3738ad3df16d2f9f3f --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=9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-22 13:21:24,506 truncating revision to first 12 chars 2017-05-22 13:21:24,506 Setting DEBUG logging. 2017-05-22 13:21:24,506 attempt 1/10 2017-05-22 13:21:24,506 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/8f4d2d35cb31?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-22 13:21:25,000 unpacking tar archive at: mozilla-central-8f4d2d35cb31/testing/mozharness/ program finished with exit code 0 elapsedTime=0.811235 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:24.038856) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:24.039161) ========= script_repo_revision: 8f4d2d35cb317235f30f4e3738ad3df16d2f9f3f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:24.039505) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:24.039775) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-22 13:21:24.054969) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 54 secs) (at 2017-05-22 13:21:24.055316) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:21:25 INFO - MultiFileLogger online at 20170522 13:21:25 in /builds/slave/test 13:21:25 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 13:21:25 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:21:25 INFO - {'append_to_log': False, 13:21:25 INFO - 'base_work_dir': '/builds/slave/test', 13:21:25 INFO - 'blob_upload_branch': 'Firefox', 13:21:25 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:21:25 INFO - 'branch': 'Firefox', 13:21:25 INFO - 'buildbot_json_path': 'buildprops.json', 13:21:25 INFO - 'config_files': ('talos/linux_config.py',), 13:21:25 INFO - 'default_actions': ('clobber', 13:21:25 INFO - 'read-buildbot-config', 13:21:25 INFO - 'download-and-extract', 13:21:25 INFO - 'populate-webroot', 13:21:25 INFO - 'create-virtualenv', 13:21:25 INFO - 'install', 13:21:25 INFO - 'run-tests'), 13:21:25 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:21:25 INFO - 'download_minidump_stackwalk': True, 13:21:25 INFO - 'download_symbols': 'ondemand', 13:21:25 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:21:25 INFO - 'tooltool.py': '/tools/tooltool.py', 13:21:25 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:21:25 INFO - '/tools/misc-python/virtualenv.py')}, 13:21:25 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:21:25 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:21:25 INFO - 'gecko_profile': False, 13:21:25 INFO - 'gecko_profile_interval': 0, 13:21:25 INFO - 'installer_path': 'installer.exe', 13:21:25 INFO - 'log_level': 'info', 13:21:25 INFO - 'log_name': 'talos', 13:21:25 INFO - 'log_to_console': True, 13:21:25 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:21:25 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:21:25 INFO - 'opt_config_files': (), 13:21:25 INFO - 'pip_index': False, 13:21:25 INFO - 'suite': 'dromaeojs-e10s', 13:21:25 INFO - 'system_bits': '32', 13:21:25 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:21:25 INFO - 'title': 'talos-linux64-ix-076', 13:21:25 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:21:25 INFO - 'use_talos_json': True, 13:21:25 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:21:25 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:21:25 INFO - 'work_dir': 'build'} 13:21:25 INFO - [mozharness: 2017-05-22 20:21:25.448534Z] Running clobber step. 13:21:25 INFO - Running pre-action listener: _resource_record_pre_action 13:21:25 INFO - Running main action method: clobber 13:21:25 INFO - rmtree: /builds/slave/test/build 13:21:25 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:21:26 INFO - Running post-action listener: _resource_record_post_action 13:21:26 INFO - [mozharness: 2017-05-22 20:21:26.475761Z] Finished clobber step (success) 13:21:26 INFO - [mozharness: 2017-05-22 20:21:26.475861Z] Running read-buildbot-config step. 13:21:26 INFO - Running pre-action listener: _resource_record_pre_action 13:21:26 INFO - Running main action method: read_buildbot_config 13:21:26 INFO - Using buildbot properties: 13:21:26 INFO - { 13:21:26 INFO - "project": "", 13:21:26 INFO - "product": "firefox", 13:21:26 INFO - "who": "cbook@mozilla.com", 13:21:26 INFO - "installer_path": "public/build/target.tar.bz2", 13:21:26 INFO - "builddir": "mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s", 13:21:26 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 13:21:26 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo-sequential mozilla-central talos dromaeojs-e10s", 13:21:26 INFO - "stage_platform": "linux64-stylosequential", 13:21:26 INFO - "basedir": "/builds/slave/test", 13:21:26 INFO - "buildnumber": 12, 13:21:26 INFO - "platform": "ubuntu64_hw_styloseq", 13:21:26 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 13:21:26 INFO - "slavebuilddir": "test", 13:21:26 INFO - "taskId": "cZQ9VgXNRcqbHPL3lx1JHA", 13:21:26 INFO - "branch": "mozilla-central", 13:21:26 INFO - "script_repo_revision": "production", 13:21:26 INFO - "revision": "8f4d2d35cb317235f30f4e3738ad3df16d2f9f3f", 13:21:26 INFO - "slavename": "talos-linux64-ix-076", 13:21:26 INFO - "repo_path": "mozilla-central" 13:21:26 INFO - } 13:21:26 INFO - Finding installer, test and symbols from parent task. 13:21:26 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/cZQ9VgXNRcqbHPL3lx1JHA'}, attempt #1 13:21:26 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/cZQ9VgXNRcqbHPL3lx1JHA'}, attempt #1 13:21:27 INFO - Task dependencies: FQ-rYfRyStmdGmVUBE59ZA 13:21:27 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA'}, attempt #1 13:21:27 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2 13:21:27 INFO - Set test_url: https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/test_packages.json 13:21:27 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.crashreporter-symbols.zip 13:21:27 INFO - Running post-action listener: _resource_record_post_action 13:21:27 INFO - [mozharness: 2017-05-22 20:21:27.823216Z] Finished read-buildbot-config step (success) 13:21:27 INFO - [mozharness: 2017-05-22 20:21:27.823436Z] Running download-and-extract step. 13:21:27 INFO - Running pre-action listener: _resource_record_pre_action 13:21:27 INFO - Running main action method: download_and_extract 13:21:27 INFO - mkdir: /builds/slave/test/build/tests 13:21:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:21:27 INFO - trying https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.test_packages.json 13:21:27 INFO - Downloading https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 13:21:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 13:21:28 INFO - Downloaded 986 bytes. 13:21:28 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 13:21:28 INFO - Using the following test package requirements: 13:21:28 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 13:21:28 INFO - u'common': [u'target.common.tests.zip'], 13:21:28 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 13:21:28 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 13:21:28 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 13:21:28 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 13:21:28 INFO - u'mozbase': [u'target.common.tests.zip'], 13:21:28 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 13:21:28 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 13:21:28 INFO - u'web-platform': [u'target.common.tests.zip', 13:21:28 INFO - u'target.web-platform.tests.zip'], 13:21:28 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 13:21:28 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 13:21:28 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.common.tests.zip 13:21:28 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.common.tests.zip'}, attempt #1 13:21:28 INFO - Fetch https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.common.tests.zip into memory 13:21:29 INFO - Content-Length response header: 63520773 13:21:29 INFO - Bytes received: 63520773 13:21:40 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 13:21:40 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.common.tests.zip 13:21:40 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.common.tests.zip'}, attempt #1 13:21:40 INFO - Fetch https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.common.tests.zip into memory 13:21:41 INFO - Content-Length response header: 63520773 13:21:41 INFO - Bytes received: 63520773 13:21:53 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.talos.tests.zip 13:21:53 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.talos.tests.zip'}, attempt #1 13:21:53 INFO - Fetch https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.talos.tests.zip into memory 13:21:54 INFO - Content-Length response header: 14410000 13:21:54 INFO - Bytes received: 14410000 13:21:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:21:54 INFO - trying https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2 13:21:54 INFO - Downloading https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 13:21:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 13:21:55 INFO - Downloaded 56483581 bytes. 13:21:55 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2 13:21:55 INFO - mkdir: /builds/slave/test/properties 13:21:55 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:21:55 INFO - Writing to file /builds/slave/test/properties/build_url 13:21:55 INFO - Contents: 13:21:55 INFO - build_url:https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2 13:21:55 INFO - Running post-action listener: _resource_record_post_action 13:21:55 INFO - Running post-action listener: set_extra_try_arguments 13:21:55 INFO - [mozharness: 2017-05-22 20:21:55.402354Z] Finished download-and-extract step (success) 13:21:55 INFO - [mozharness: 2017-05-22 20:21:55.402451Z] Running populate-webroot step. 13:21:55 INFO - Running pre-action listener: _resource_record_pre_action 13:21:55 INFO - Running main action method: populate_webroot 13:21:55 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:21:55 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:21:55 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:21:55 INFO - '--tppagecycles', 13:21:55 INFO - '7'], 13:21:55 INFO - 'tests': ['tsvgm']}}, 13:21:55 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:21:55 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 13:21:55 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:21:55 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 13:21:55 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:21:55 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:21:55 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['damp', 'tps']}, 13:21:55 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'tests': ['damp', 'tps']}, 13:21:55 INFO - 'g3': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['dromaeo_dom']}, 13:21:55 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:21:55 INFO - 'g4': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 13:21:55 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 13:21:55 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'tests': ['ts_paint', 'tp5o']}, 13:21:55 INFO - 'other': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['a11yr', 13:21:55 INFO - 'ts_paint', 13:21:55 INFO - 'tpaint', 13:21:55 INFO - 'sessionrestore', 13:21:55 INFO - 'sessionrestore_no_auto_restore', 13:21:55 INFO - 'tabpaint']}, 13:21:55 INFO - 'other-e10s': {'tests': ['a11yr', 13:21:55 INFO - 'ts_paint', 13:21:55 INFO - 'tpaint', 13:21:55 INFO - 'sessionrestore', 13:21:55 INFO - 'sessionrestore_no_auto_restore', 13:21:55 INFO - 'tabpaint']}, 13:21:55 INFO - 'other-e10s_l64': {'tests': ['a11yr', 13:21:55 INFO - 'ts_paint', 13:21:55 INFO - 'tpaint', 13:21:55 INFO - 'sessionrestore', 13:21:55 INFO - 'sessionrestore_no_auto_restore', 13:21:55 INFO - 'tabpaint']}, 13:21:55 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 13:21:55 INFO - 'ts_paint', 13:21:55 INFO - 'tpaint', 13:21:55 INFO - 'sessionrestore', 13:21:55 INFO - 'sessionrestore_no_auto_restore', 13:21:55 INFO - 'tabpaint']}, 13:21:55 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['a11yr', 13:21:55 INFO - 'ts_paint', 13:21:55 INFO - 'tpaint', 13:21:55 INFO - 'sessionrestore', 13:21:55 INFO - 'sessionrestore_no_auto_restore', 13:21:55 INFO - 'tabpaint']}, 13:21:55 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['a11yr', 13:21:55 INFO - 'ts_paint', 13:21:55 INFO - 'tpaint', 13:21:55 INFO - 'sessionrestore', 13:21:55 INFO - 'sessionrestore_no_auto_restore', 13:21:55 INFO - 'tabpaint']}, 13:21:55 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 13:21:55 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 13:21:55 INFO - 'bloom_basic_ref']}, 13:21:55 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['tsvgx', 13:21:55 INFO - 'tsvgr_opacity', 13:21:55 INFO - 'tart', 13:21:55 INFO - 'tscrollx', 13:21:55 INFO - 'cart', 13:21:55 INFO - 'tsvg_static']}, 13:21:55 INFO - 'svgr-e10s': {'tests': ['tsvgx', 13:21:55 INFO - 'tsvgr_opacity', 13:21:55 INFO - 'tart', 13:21:55 INFO - 'tscrollx', 13:21:55 INFO - 'cart', 13:21:55 INFO - 'tsvg_static']}, 13:21:55 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'talos_options': ['--disable-e10s'], 13:21:55 INFO - 'tests': ['tp5o']}, 13:21:55 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 13:21:55 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'talos_options': ['--disable-e10s', 13:21:55 INFO - '--xperf_path', 13:21:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:21:55 INFO - 'tests': ['tp5n']}, 13:21:55 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 13:21:55 INFO - 'talos_options': ['--xperf_path', 13:21:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:21:55 INFO - 'tests': ['tp5n']}}, 13:21:55 INFO - 'talos.zip': {'path': '', 13:21:55 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:21:55 INFO - Running post-action listener: _resource_record_post_action 13:21:55 INFO - [mozharness: 2017-05-22 20:21:55.416384Z] Finished populate-webroot step (success) 13:21:55 INFO - [mozharness: 2017-05-22 20:21:55.416472Z] Running create-virtualenv step. 13:21:55 INFO - Running pre-action listener: _resource_record_pre_action 13:21:55 INFO - Running main action method: create_virtualenv 13:21:55 INFO - Creating virtualenv /builds/slave/test/build/venv 13:21:55 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 13:21:55 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:21:55 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:21:55 INFO - Using real prefix '/usr' 13:21:55 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:21:56 INFO - Installing distribute.............................................................................................................................................................................................done. 13:21:57 INFO - Installing pip.................done. 13:21:57 INFO - Return code: 0 13:21:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 13:21:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 13:21:58 INFO - Reading from file tmpfile_stdout 13:21:58 INFO - Output received: 13:21:58 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 13:21:58 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:21:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:21:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:21:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:21:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:21:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:21:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 13:21:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 13:21:58 INFO - Using env: {'DISPLAY': ':0', 13:21:58 INFO - 'HOME': '/home/cltbld', 13:21:58 INFO - 'LANG': 'en_US.UTF-8', 13:21:58 INFO - 'LANGUAGE': 'en_US:en', 13:21:58 INFO - 'LOGNAME': 'cltbld', 13:21:58 INFO - 'MAIL': '/var/mail/cltbld', 13:21:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:21:58 INFO - 'MOZ_NO_REMOTE': '1', 13:21:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:21:58 INFO - 'NO_EM_RESTART': '1', 13:21:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:21:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:21:58 INFO - 'PWD': '/builds/slave/test', 13:21:58 INFO - 'SHELL': '/bin/bash', 13:21:58 INFO - 'SHLVL': '1', 13:21:58 INFO - 'TERM': 'linux', 13:21:58 INFO - 'TMOUT': '86400', 13:21:58 INFO - 'USER': 'cltbld', 13:21:58 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:21:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:21:58 INFO - '_': '/tools/buildbot/bin/python'} 13:21:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:21:58 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 13:21:58 INFO - Cleaning up... 13:21:58 INFO - Return code: 0 13:21:58 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 13:21:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:21:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:21:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:21:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:21:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:21:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 13:21:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 13:21:58 INFO - Using env: {'DISPLAY': ':0', 13:21:58 INFO - 'HOME': '/home/cltbld', 13:21:58 INFO - 'LANG': 'en_US.UTF-8', 13:21:58 INFO - 'LANGUAGE': 'en_US:en', 13:21:58 INFO - 'LOGNAME': 'cltbld', 13:21:58 INFO - 'MAIL': '/var/mail/cltbld', 13:21:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:21:58 INFO - 'MOZ_NO_REMOTE': '1', 13:21:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:21:58 INFO - 'NO_EM_RESTART': '1', 13:21:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:21:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:21:58 INFO - 'PWD': '/builds/slave/test', 13:21:58 INFO - 'SHELL': '/bin/bash', 13:21:58 INFO - 'SHLVL': '1', 13:21:58 INFO - 'TERM': 'linux', 13:21:58 INFO - 'TMOUT': '86400', 13:21:58 INFO - 'USER': 'cltbld', 13:21:58 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:21:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:21:58 INFO - '_': '/tools/buildbot/bin/python'} 13:21:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:21:58 INFO - Downloading/unpacking psutil>=3.1.1 13:21:58 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 13:21:58 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 13:21:58 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 13:21:58 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 13:21:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:22:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:22:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:22:00 INFO - Installing collected packages: psutil 13:22:00 INFO - Running setup.py install for psutil 13:22:00 INFO - building 'psutil._psutil_linux' extension 13:22:00 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 13:22:00 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 13:22:00 INFO - building 'psutil._psutil_posix' extension 13:22:00 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 13:22:00 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 13:22:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:22:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:22:00 INFO - Successfully installed psutil 13:22:00 INFO - Cleaning up... 13:22:00 INFO - Return code: 0 13:22:00 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 13:22:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 13:22:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 13:22:00 INFO - Using env: {'DISPLAY': ':0', 13:22:00 INFO - 'HOME': '/home/cltbld', 13:22:00 INFO - 'LANG': 'en_US.UTF-8', 13:22:00 INFO - 'LANGUAGE': 'en_US:en', 13:22:00 INFO - 'LOGNAME': 'cltbld', 13:22:00 INFO - 'MAIL': '/var/mail/cltbld', 13:22:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:00 INFO - 'MOZ_NO_REMOTE': '1', 13:22:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:00 INFO - 'NO_EM_RESTART': '1', 13:22:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:00 INFO - 'PWD': '/builds/slave/test', 13:22:00 INFO - 'SHELL': '/bin/bash', 13:22:00 INFO - 'SHLVL': '1', 13:22:00 INFO - 'TERM': 'linux', 13:22:00 INFO - 'TMOUT': '86400', 13:22:00 INFO - 'USER': 'cltbld', 13:22:00 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:00 INFO - '_': '/tools/buildbot/bin/python'} 13:22:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:00 INFO - Downloading/unpacking mozsystemmonitor==0.3 13:22:00 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 13:22:00 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 13:22:00 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 13:22:00 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 13:22:01 INFO - Downloading mozsystemmonitor-0.3.tar.gz 13:22:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:22:01 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 13:22:01 INFO - Installing collected packages: mozsystemmonitor 13:22:01 INFO - Running setup.py install for mozsystemmonitor 13:22:02 INFO - Successfully installed mozsystemmonitor 13:22:02 INFO - Cleaning up... 13:22:02 INFO - Return code: 0 13:22:02 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 13:22:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 13:22:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 13:22:02 INFO - Using env: {'DISPLAY': ':0', 13:22:02 INFO - 'HOME': '/home/cltbld', 13:22:02 INFO - 'LANG': 'en_US.UTF-8', 13:22:02 INFO - 'LANGUAGE': 'en_US:en', 13:22:02 INFO - 'LOGNAME': 'cltbld', 13:22:02 INFO - 'MAIL': '/var/mail/cltbld', 13:22:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:02 INFO - 'MOZ_NO_REMOTE': '1', 13:22:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:02 INFO - 'NO_EM_RESTART': '1', 13:22:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:02 INFO - 'PWD': '/builds/slave/test', 13:22:02 INFO - 'SHELL': '/bin/bash', 13:22:02 INFO - 'SHLVL': '1', 13:22:02 INFO - 'TERM': 'linux', 13:22:02 INFO - 'TMOUT': '86400', 13:22:02 INFO - 'USER': 'cltbld', 13:22:02 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:02 INFO - '_': '/tools/buildbot/bin/python'} 13:22:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:02 INFO - Downloading/unpacking jsonschema==2.5.1 13:22:02 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 13:22:02 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 13:22:02 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 13:22:02 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 13:22:03 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:22:03 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 13:22:03 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 13:22:03 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 13:22:03 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 13:22:03 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 13:22:03 INFO - Downloading functools32-3.2.3-2.tar.gz 13:22:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:22:03 INFO - warning: no files found matching '*.txt' 13:22:03 INFO - no previously-included directories found matching 'build' 13:22:03 INFO - no previously-included directories found matching 'dist' 13:22:03 INFO - no previously-included directories found matching '.git*' 13:22:03 INFO - Installing collected packages: jsonschema, functools32 13:22:03 INFO - Running setup.py install for functools32 13:22:03 INFO - warning: no files found matching '*.txt' 13:22:03 INFO - no previously-included directories found matching 'build' 13:22:03 INFO - no previously-included directories found matching 'dist' 13:22:03 INFO - no previously-included directories found matching '.git*' 13:22:03 INFO - Successfully installed jsonschema functools32 13:22:03 INFO - Cleaning up... 13:22:03 INFO - Return code: 0 13:22:03 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 13:22:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 13:22:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 13:22:03 INFO - Using env: {'DISPLAY': ':0', 13:22:03 INFO - 'HOME': '/home/cltbld', 13:22:03 INFO - 'LANG': 'en_US.UTF-8', 13:22:03 INFO - 'LANGUAGE': 'en_US:en', 13:22:03 INFO - 'LOGNAME': 'cltbld', 13:22:03 INFO - 'MAIL': '/var/mail/cltbld', 13:22:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:03 INFO - 'MOZ_NO_REMOTE': '1', 13:22:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:03 INFO - 'NO_EM_RESTART': '1', 13:22:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:03 INFO - 'PWD': '/builds/slave/test', 13:22:03 INFO - 'SHELL': '/bin/bash', 13:22:03 INFO - 'SHLVL': '1', 13:22:03 INFO - 'TERM': 'linux', 13:22:03 INFO - 'TMOUT': '86400', 13:22:03 INFO - 'USER': 'cltbld', 13:22:03 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:03 INFO - '_': '/tools/buildbot/bin/python'} 13:22:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:03 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 13:22:03 INFO - Cleaning up... 13:22:03 INFO - Return code: 0 13:22:03 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:22:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 13:22:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 13:22:03 INFO - Using env: {'DISPLAY': ':0', 13:22:03 INFO - 'HOME': '/home/cltbld', 13:22:03 INFO - 'LANG': 'en_US.UTF-8', 13:22:03 INFO - 'LANGUAGE': 'en_US:en', 13:22:03 INFO - 'LOGNAME': 'cltbld', 13:22:03 INFO - 'MAIL': '/var/mail/cltbld', 13:22:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:03 INFO - 'MOZ_NO_REMOTE': '1', 13:22:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:03 INFO - 'NO_EM_RESTART': '1', 13:22:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:03 INFO - 'PWD': '/builds/slave/test', 13:22:03 INFO - 'SHELL': '/bin/bash', 13:22:03 INFO - 'SHLVL': '1', 13:22:03 INFO - 'TERM': 'linux', 13:22:03 INFO - 'TMOUT': '86400', 13:22:03 INFO - 'USER': 'cltbld', 13:22:03 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:03 INFO - '_': '/tools/buildbot/bin/python'} 13:22:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:04 INFO - Downloading/unpacking blobuploader==1.2.4 13:22:04 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 13:22:04 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 13:22:04 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 13:22:04 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 13:22:05 INFO - Downloading blobuploader-1.2.4.tar.gz 13:22:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:22:05 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:22:05 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 13:22:05 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 13:22:05 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 13:22:05 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 13:22:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:22:05 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:22:05 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 13:22:05 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 13:22:05 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 13:22:05 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 13:22:05 INFO - Downloading docopt-0.6.1.tar.gz 13:22:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:22:05 INFO - Installing collected packages: blobuploader, requests, docopt 13:22:05 INFO - Running setup.py install for blobuploader 13:22:05 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:22:05 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:22:06 INFO - Running setup.py install for requests 13:22:06 INFO - Running setup.py install for docopt 13:22:06 INFO - Successfully installed blobuploader requests docopt 13:22:06 INFO - Cleaning up... 13:22:06 INFO - Return code: 0 13:22:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:22:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--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 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--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 13:22:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:22:06 INFO - Using env: {'DISPLAY': ':0', 13:22:06 INFO - 'HOME': '/home/cltbld', 13:22:06 INFO - 'LANG': 'en_US.UTF-8', 13:22:06 INFO - 'LANGUAGE': 'en_US:en', 13:22:06 INFO - 'LOGNAME': 'cltbld', 13:22:06 INFO - 'MAIL': '/var/mail/cltbld', 13:22:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:06 INFO - 'MOZ_NO_REMOTE': '1', 13:22:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:06 INFO - 'NO_EM_RESTART': '1', 13:22:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:06 INFO - 'PWD': '/builds/slave/test', 13:22:06 INFO - 'SHELL': '/bin/bash', 13:22:06 INFO - 'SHLVL': '1', 13:22:06 INFO - 'TERM': 'linux', 13:22:06 INFO - 'TMOUT': '86400', 13:22:06 INFO - 'USER': 'cltbld', 13:22:06 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:06 INFO - '_': '/tools/buildbot/bin/python'} 13:22:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:22:06 INFO - Running setup.py (path:/tmp/pip-kG4awN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:22:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:22:06 INFO - Running setup.py (path:/tmp/pip-4cjFfO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:22:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:22:06 INFO - Running setup.py (path:/tmp/pip-tlfVgc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:22:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:22:06 INFO - Running setup.py (path:/tmp/pip-qYx2ur-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:22:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:22:07 INFO - Running setup.py (path:/tmp/pip-ZrDEUp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:22:07 INFO - Running setup.py (path:/tmp/pip-4AaEZW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:22:07 INFO - Running setup.py (path:/tmp/pip-nZkZex-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:22:07 INFO - Running setup.py (path:/tmp/pip-2zIkWz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:22:07 INFO - Running setup.py (path:/tmp/pip-9iD2FS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:22:07 INFO - Running setup.py (path:/tmp/pip-IhskgJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:22:07 INFO - Running setup.py (path:/tmp/pip-XQf3Xr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:22:07 INFO - Running setup.py (path:/tmp/pip-HiIdt5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:22:07 INFO - Running setup.py (path:/tmp/pip-12ykZ0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:22:07 INFO - Running setup.py (path:/tmp/pip-FL2zQM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:22:07 INFO - Running setup.py (path:/tmp/pip-MHnJHR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:22:07 INFO - Running setup.py (path:/tmp/pip-5V7noX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:22:07 INFO - Running setup.py (path:/tmp/pip-kicy1R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:22:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:22:07 INFO - Running setup.py install for manifestparser 13:22:08 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Running setup.py install for mozcrash 13:22:08 INFO - Running setup.py install for mozdebug 13:22:08 INFO - Running setup.py install for mozdevice 13:22:08 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Running setup.py install for mozfile 13:22:08 INFO - Running setup.py install for mozhttpd 13:22:08 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Running setup.py install for mozinfo 13:22:08 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Running setup.py install for mozInstall 13:22:08 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Running setup.py install for mozleak 13:22:08 INFO - Running setup.py install for mozlog 13:22:08 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:22:08 INFO - Running setup.py install for moznetwork 13:22:09 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:22:09 INFO - Running setup.py install for mozprocess 13:22:09 INFO - Running setup.py install for mozprofile 13:22:09 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:22:09 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:22:09 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:22:09 INFO - Running setup.py install for mozrunner 13:22:09 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:22:09 INFO - Running setup.py install for mozscreenshot 13:22:09 INFO - Running setup.py install for moztest 13:22:09 INFO - Running setup.py install for mozversion 13:22:09 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:22:09 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:22:09 INFO - Cleaning up... 13:22:09 INFO - Return code: 0 13:22:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:22:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--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 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--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 13:22:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:22:09 INFO - Using env: {'DISPLAY': ':0', 13:22:09 INFO - 'HOME': '/home/cltbld', 13:22:09 INFO - 'LANG': 'en_US.UTF-8', 13:22:09 INFO - 'LANGUAGE': 'en_US:en', 13:22:09 INFO - 'LOGNAME': 'cltbld', 13:22:09 INFO - 'MAIL': '/var/mail/cltbld', 13:22:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:09 INFO - 'MOZ_NO_REMOTE': '1', 13:22:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:09 INFO - 'NO_EM_RESTART': '1', 13:22:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:09 INFO - 'PWD': '/builds/slave/test', 13:22:09 INFO - 'SHELL': '/bin/bash', 13:22:09 INFO - 'SHLVL': '1', 13:22:09 INFO - 'TERM': 'linux', 13:22:09 INFO - 'TMOUT': '86400', 13:22:09 INFO - 'USER': 'cltbld', 13:22:09 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:09 INFO - '_': '/tools/buildbot/bin/python'} 13:22:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:22:09 INFO - Running setup.py (path:/tmp/pip-eBGRBb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:22:10 INFO - Running setup.py (path:/tmp/pip-0S5Ygs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:22:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:22:10 INFO - Running setup.py (path:/tmp/pip-mNW1rf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:22:10 INFO - Running setup.py (path:/tmp/pip-fiQx8H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:22:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:22:10 INFO - Running setup.py (path:/tmp/pip-ofVKif-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:22:10 INFO - Running setup.py (path:/tmp/pip-BacM5w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:22:10 INFO - Running setup.py (path:/tmp/pip-zdutVJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:22:10 INFO - Running setup.py (path:/tmp/pip-eKrycU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:22:10 INFO - Running setup.py (path:/tmp/pip-0pb0NT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:22:10 INFO - Running setup.py (path:/tmp/pip-PDc7DY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:22:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:22:10 INFO - Running setup.py (path:/tmp/pip-Zf0lCC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:22:10 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:22:10 INFO - Running setup.py (path:/tmp/pip-5AYrUf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:22:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:22:10 INFO - Running setup.py (path:/tmp/pip-7Rey_q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:22:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:22:10 INFO - Running setup.py (path:/tmp/pip-8WMhMs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:22:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 13:22:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:22:10 INFO - Running setup.py (path:/tmp/pip-k_S5t8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:22:11 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)) 13:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:22:11 INFO - Running setup.py (path:/tmp/pip-FLnHS4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:22:11 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 13:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:22:11 INFO - Running setup.py (path:/tmp/pip-XxY5SR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:22:11 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)) 13:22:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:22:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:22:11 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)) 13:22:11 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 13:22:11 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 13:22:11 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:22:11 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 13:22:11 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 13:22:11 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 13:22:11 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 13:22:12 INFO - Downloading blessings-1.6.tar.gz 13:22:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:22:12 INFO - Installing collected packages: blessings 13:22:12 INFO - Running setup.py install for blessings 13:22:12 INFO - Successfully installed blessings 13:22:12 INFO - Cleaning up... 13:22:12 INFO - Return code: 0 13:22:12 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:22:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:22:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:22:12 INFO - Reading from file tmpfile_stdout 13:22:12 INFO - Current package versions: 13:22:12 INFO - argparse == 1.2.1 13:22:12 INFO - blessings == 1.6 13:22:12 INFO - blobuploader == 1.2.4 13:22:12 INFO - docopt == 0.6.1 13:22:12 INFO - functools32 == 3.2.3-2 13:22:12 INFO - jsonschema == 2.5.1 13:22:12 INFO - manifestparser == 1.1 13:22:12 INFO - mozInstall == 1.12 13:22:12 INFO - mozcrash == 1.0 13:22:12 INFO - mozdebug == 0.1 13:22:12 INFO - mozdevice == 0.50 13:22:12 INFO - mozfile == 1.2 13:22:12 INFO - mozhttpd == 0.7 13:22:12 INFO - mozinfo == 0.9 13:22:12 INFO - mozleak == 0.1 13:22:12 INFO - mozlog == 3.4 13:22:12 INFO - moznetwork == 0.27 13:22:12 INFO - mozprocess == 0.25 13:22:12 INFO - mozprofile == 0.28 13:22:12 INFO - mozrunner == 6.13 13:22:12 INFO - mozscreenshot == 0.1 13:22:12 INFO - mozsystemmonitor == 0.3 13:22:12 INFO - moztest == 0.8 13:22:12 INFO - mozversion == 1.4 13:22:12 INFO - psutil == 3.1.1 13:22:12 INFO - requests == 1.2.3 13:22:12 INFO - wsgiref == 0.1.2 13:22:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:22:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--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 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--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 13:22:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:22:12 INFO - Using env: {'DISPLAY': ':0', 13:22:12 INFO - 'HOME': '/home/cltbld', 13:22:12 INFO - 'LANG': 'en_US.UTF-8', 13:22:12 INFO - 'LANGUAGE': 'en_US:en', 13:22:12 INFO - 'LOGNAME': 'cltbld', 13:22:12 INFO - 'MAIL': '/var/mail/cltbld', 13:22:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:12 INFO - 'MOZ_NO_REMOTE': '1', 13:22:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:12 INFO - 'NO_EM_RESTART': '1', 13:22:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:12 INFO - 'PWD': '/builds/slave/test', 13:22:12 INFO - 'SHELL': '/bin/bash', 13:22:12 INFO - 'SHLVL': '1', 13:22:12 INFO - 'TERM': 'linux', 13:22:12 INFO - 'TMOUT': '86400', 13:22:12 INFO - 'USER': 'cltbld', 13:22:12 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:12 INFO - '_': '/tools/buildbot/bin/python'} 13:22:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 13:22:12 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 2)) 13:22:12 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 3)) 13:22:12 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 4)) 13:22:12 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 5)) 13:22:12 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 6)) 13:22:12 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 7)) 13:22:12 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 8)) 13:22:12 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 9)) 13:22:12 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.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 13:22:12 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 4)) 13:22:12 INFO - Cleaning up... 13:22:12 INFO - Return code: 0 13:22:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:22:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:22:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:22:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x262d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27faa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29a05c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, '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': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', '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 13:22:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 13:22:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 13:22:12 INFO - Using env: {'DISPLAY': ':0', 13:22:12 INFO - 'HOME': '/home/cltbld', 13:22:12 INFO - 'LANG': 'en_US.UTF-8', 13:22:12 INFO - 'LANGUAGE': 'en_US:en', 13:22:12 INFO - 'LOGNAME': 'cltbld', 13:22:12 INFO - 'MAIL': '/var/mail/cltbld', 13:22:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:12 INFO - 'MOZ_NO_REMOTE': '1', 13:22:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:12 INFO - 'NO_EM_RESTART': '1', 13:22:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:12 INFO - 'PWD': '/builds/slave/test', 13:22:12 INFO - 'SHELL': '/bin/bash', 13:22:12 INFO - 'SHLVL': '1', 13:22:12 INFO - 'TERM': 'linux', 13:22:12 INFO - 'TMOUT': '86400', 13:22:12 INFO - 'USER': 'cltbld', 13:22:12 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:12 INFO - '_': '/tools/buildbot/bin/python'} 13:22:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:22:13 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 13:22:13 INFO - Cleaning up... 13:22:13 INFO - Return code: 0 13:22:13 INFO - Running post-action listener: _resource_record_post_action 13:22:13 INFO - Running post-action listener: _start_resource_monitoring 13:22:13 INFO - Starting resource monitoring. 13:22:13 INFO - [mozharness: 2017-05-22 20:22:13.231579Z] Finished create-virtualenv step (success) 13:22:13 INFO - [mozharness: 2017-05-22 20:22:13.232129Z] Running install step. 13:22:13 INFO - Running pre-action listener: _resource_record_pre_action 13:22:13 INFO - Running main action method: install 13:22:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:22:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:22:13 INFO - Reading from file tmpfile_stdout 13:22:13 INFO - Detecting whether we're running mozinstall >=1.0... 13:22:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:22:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:22:13 INFO - Reading from file tmpfile_stdout 13:22:13 INFO - Output received: 13:22:13 INFO - Usage: mozinstall [options] installer 13:22:13 INFO - Options: 13:22:13 INFO - -h, --help show this help message and exit 13:22:13 INFO - -d DEST, --destination=DEST 13:22:13 INFO - Directory to install application into. [default: 13:22:13 INFO - "/builds/slave/test"] 13:22:13 INFO - --app=APP Application being installed. [default: firefox] 13:22:13 INFO - mkdir: /builds/slave/test/build/application 13:22:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 13:22:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 13:22:29 INFO - Reading from file tmpfile_stdout 13:22:29 INFO - Output received: 13:22:29 INFO - /builds/slave/test/build/application/firefox/firefox 13:22:29 INFO - Running post-action listener: _resource_record_post_action 13:22:29 INFO - [mozharness: 2017-05-22 20:22:29.669550Z] Finished install step (success) 13:22:29 INFO - [mozharness: 2017-05-22 20:22:29.669827Z] Running run-tests step. 13:22:29 INFO - Running pre-action listener: _resource_record_pre_action 13:22:29 INFO - Running main action method: run_tests 13:22:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:22:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:22:29 INFO - Python 2.7.3 13:22:29 INFO - Return code: 0 13:22:29 INFO - grabbing minidump binary from tooltool 13:22:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:22:29 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d7a0>, '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 0x299e6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x299eb30>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:22:29 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 13:22:29 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 13:22:29 INFO - Calling ['/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'] with output_timeout 600 13:22:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:22:29 INFO - Return code: 0 13:22:29 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:22:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:22:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:22:29 INFO - ENV: RUST_BACKTRACE is now 1 13:22:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:22:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:22:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-076', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 13:22:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-076 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 13:22:29 INFO - Using env: {'DISPLAY': ':0', 13:22:29 INFO - 'HOME': '/home/cltbld', 13:22:29 INFO - 'LANG': 'en_US.UTF-8', 13:22:29 INFO - 'LANGUAGE': 'en_US:en', 13:22:29 INFO - 'LOGNAME': 'cltbld', 13:22:29 INFO - 'MAIL': '/var/mail/cltbld', 13:22:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:22:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:22:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:22:29 INFO - 'MOZ_NO_REMOTE': '1', 13:22:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:22:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:22:29 INFO - 'NO_EM_RESTART': '1', 13:22:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:22:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:22:29 INFO - 'PWD': '/builds/slave/test', 13:22:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:22:29 INFO - 'RUST_BACKTRACE': '1', 13:22:29 INFO - 'SHELL': '/bin/bash', 13:22:29 INFO - 'SHLVL': '1', 13:22:29 INFO - 'TERM': 'linux', 13:22:29 INFO - 'TMOUT': '86400', 13:22:29 INFO - 'USER': 'cltbld', 13:22:29 INFO - 'XDG_SESSION_COOKIE': '9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029', 13:22:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:22:29 INFO - '_': '/tools/buildbot/bin/python'} 13:22:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-076', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 13:22:29 INFO - mozversion application_buildid: 20170522134620 13:22:29 INFO - mozversion application_changeset: 8f4d2d35cb317235f30f4e3738ad3df16d2f9f3f 13:22:29 INFO - mozversion application_display_name: Nightly 13:22:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:22:29 INFO - mozversion application_name: Firefox 13:22:29 INFO - mozversion application_remotingname: firefox 13:22:29 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 13:22:29 INFO - mozversion application_vendor: Mozilla 13:22:29 INFO - mozversion application_version: 55.0a1 13:22:29 INFO - mozversion platform_buildid: 20170522134620 13:22:29 INFO - mozversion platform_changeset: 8f4d2d35cb317235f30f4e3738ad3df16d2f9f3f 13:22:29 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 13:22:29 INFO - mozversion platform_version: 55.0a1 13:22:29 INFO - using testdate: 1495484549 13:22:29 INFO - actual date: 1495484549 13:22:29 INFO - starting webserver on 'localhost:35888' 13:22:29 INFO - SUITE-START | Running 2 tests 13:22:29 INFO - TEST-START | dromaeo_css 13:22:29 INFO - operating with platform_type : linux_ 13:22:29 INFO - Initialising browser for dromaeo_css test... 13:22:29 INFO - TEST-INFO | started process 20969 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpo1erff/profile http://localhost:35888/getInfo.html) 13:22:30 INFO - PID 20969 | JavaScript warning: resource://gre/modules/addons/XPIProvider.jsm, line 2978: String.localeCompare is deprecated; use String.prototype.localeCompare instead 13:22:34 INFO - PID 20969 | __metrics Screen width/height:1600/1200 13:22:34 INFO - PID 20969 | colorDepth:24 13:22:34 INFO - PID 20969 | Browser inner width/height: 1024/695 13:22:34 INFO - PID 20969 | __metrics 13:22:36 INFO - TEST-INFO | 20969: exit 0 13:22:36 INFO - Browser initialized. 13:22:36 INFO - Running cycle 1/1 for dromaeo_css test... 13:22:36 INFO - TEST-INFO | started process 21149 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpo1erff/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:22:48 INFO - PID 21149 | RSS: Main: 169889792 13:22:48 INFO - PID 21149 | 13:25:52 INFO - PID 21149 | Cycle 1(1): loaded http://localhost:35888/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35888/tests/dromaeo/cssquery-ext.html) 13:25:54 INFO - PID 21149 | RSS: Main: 172482560 13:25:54 INFO - PID 21149 | 13:28:56 INFO - PID 21149 | Cycle 1(1): loaded http://localhost:35888/tests/dromaeo/cssquery-ext.html (next: http://localhost:35888/tests/dromaeo/cssquery-jquery.html) 13:28:57 INFO - PID 21149 | RSS: Main: 173080576 13:28:57 INFO - PID 21149 | 13:31:59 INFO - PID 21149 | Cycle 1(1): loaded http://localhost:35888/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35888/tests/dromaeo/cssquery-mootools.html) 13:31:59 INFO - PID 21149 | RSS: Main: 174387200 13:31:59 INFO - PID 21149 | 13:35:01 INFO - PID 21149 | Cycle 1(1): loaded http://localhost:35888/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35888/tests/dromaeo/cssquery-prototype.html) 13:35:02 INFO - PID 21149 | RSS: Main: 171900928 13:35:02 INFO - PID 21149 | 13:38:05 INFO - PID 21149 | Cycle 1(1): loaded http://localhost:35888/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35888/tests/dromaeo/cssquery-yui.html) 13:38:05 INFO - PID 21149 | RSS: Main: 173662208 13:38:05 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | Cycle 1(1): loaded http://localhost:35888/tests/dromaeo/cssquery-yui.html (next: http://localhost:35888/tests/dromaeo/cssquery-dojo.html) 13:41:07 INFO - PID 21149 | RSS: Main: 180133888 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | __start_tp_report 13:41:07 INFO - PID 21149 | _x_x_mozilla_page_load 13:41:07 INFO - PID 21149 | _x_x_mozilla_page_load_details 13:41:07 INFO - PID 21149 | |i|pagename|runs| 13:41:07 INFO - PID 21149 | |0;dojo.html;2700.189943017095;2705.296622878051;2740.8492532910695;2750.1062154799683;2762.0470937526547;5173;5208.557272631826;5251.711155886434;5257.947420525794;5269.394019687732;5175.482451754822;5204.895902081956;5216.9478305216935;5241.10901146805;5296.8146114885985;4602.424696912894;4615.3077038444335;4620;4631.884202894921;4706.22347312693;4680.391549098613;4688.390509233812;4707.482176960549;4721.055788842245;4725.196716558176;4590.265557510782;4601.585857272861;4645.349651048856;4657.417822772153;4685.086408150412;4671.089137618166;4677.134730074947;4682.29765535169;4689.648276379251;4717.457492388351;4583.541645835423;4633.212353899845;4633.953660463386;4669.41632295963;4706.29405589161;5071.8985620287385;5100.5409513143995;5186.222066689989;5206.557442617382;5251.921221181686;5612.382637909826;5617.831465056014;5634.521065709419;5662.518685911702;5703.857403564944;5671.262735844314;5671.404502527216;5683.857903552403;5685.886282274373;5697.658140511541;5172.612054095883;5235.895282094337;5244;5257.947420525746;5266.526012658879;5763.2507773989955;5787.768489260467;5802.941970580325;5811.186433899257;5821;5554.666719996813;5612.831615051555;5615.803446879339;5615.831525054255;5636.549076073904;5551.472610102114;5624.409437009137;5627.46539078795;5635.0702134147405;5640.435956404327;5604.663720176803;5605.915911261334;5606.803761868315;5607.243022191952;5612.102063669793;5521.806736764194;5608.523275521545;5611.018071837412;5616.85957851057;5617.129344951539;4621.560951709582;4640.721556706609;4677.134730074947;4695.460022097503;4699.929501057487;3992.8802135935966;4012.7792971386853;4015.8996025099605;4018.3168861293652;4051.7974101294817;4763.118823017753;4767.976160119178;4770.332153498513;4803.759812009385;4805.591524720368;5530.170474428868;5568.49883510486;5582.525485333711;5613.578981576398;5643.915341269884;4744.572988431058;4775.928361074587;4776.09254241693;4796.952030479651;4826.0347930414055;4938.209886418228;4947.480514545993;4974.228994505857;4975.203967365204;4993.201087825931;5142.485751424828;5241.50205730455;5245.3181086460045;5250.18622113573;5289.2330612061805;5481.972590137024;5493.890122197614;5535.806246781343;5545.916811247916;5560.5551555876245;5112.284280200849;5145.07388670043;5157.174852023658;5223.895522089613;5232.581393488588;5477.096279114061;5543.113101903676;5552.167174923794;5557.833265002057;5558;5524;5559.4162612926675;5627.718614069362;5633.0987042073075;5633.126865335879;5456.645318054314;5463.153211252262;5492.340919089735;5494.450554944474;5499.1476321170285;5469.589780766538;5480.917786233289;5492.450754924475;5554.1391084381985;5555.777768889199;5363.919541206963;5369.758360873692;5390.434004429479;5423.810166644149;5433.076377015996;5467.808626698046;5483.533899618577;5489.890202195854;5534.557235421237;5541.33503979525;5111.3355263815465;5287.286216360742;5308.320097495643;5323.307969964035;5356.892862142813 13:41:07 INFO - PID 21149 | |1;ext.html;662.5395350231588;721.1130309719045;745.4446437404133;1071.0146665068141;1073.1414868105524;32292.192695182603;32876.83561582192;33105.84129555466;33237.83381083094;33351.66648333516;34913;35233.82383088081;35252.2949541009;35376.51663992079;35439.822800886024;6813.488988325883;6926.688299026556;6941;6943.479239057091;7043;6982.33667801558;7077.221505634376;7081.858362832741;7089.8227544311285;7090.929090709078;7042.929570704278;7054.964725176367;7097.21930587635;7112;7114.075170227863;7045.68294426752;7059.9647001764915;7071.36357727807;7081.964590177067;7088.397486213678;6668.399844014013;6677.899831502531;6680.031395447633;6686.732530698766;6689.397954184098;31647.20881977946;31740.206494837585;31848;31884.36231275385;32095.358092838247;3051.3897220555755;3063.0657649416917;3080.799748016394;3085.4754691702465;3088.7528997680133;24383.634245486333;24419.14532991337;24601.261962141165;24625.507489850283;24655.753442465706;3040.9087727368214;3077.8768849246003;3091.938161236763;3094.7060029297404;3100.100970718489;146319;146477;147601;154445.22777386152;155198;39068.609313907065;39257;39341.803290983364;39375.2124957505;39384;41176.176476470304;41230.38154427686;41239.84501937258;41278.38082428766;41369.79315103465;10862.565497380174;11004.449777511092;11019;11040.171987101;11052.392118433563;8552.144785521397;8593.527355995355;8596.78508037304;8603.451378751884;8624.266937310398;12582.43379047945;12669.366531673379;12678.985681145487;12757.936210318889;12841.550545730855;5244;5245.947540524622;5315.707636080053;5362.597805164628;5373.871486987777;867.2584939876441;871.3813192633302;882.7925437522306;885.5439448683933;911.6034524981654;20019.599608007757;20769.58460830775;21107.68338474924;21155.78844211569;21369.252076177258;933.6125507914276;943.5140902435252;943.8631398447187;969.9466529340813;995.0646392391129;10558;11064.28082174656;11145.944270278758;11213;11304.773904522028;182187;183091;183181;183860;183893;39761.2047759049;40057.79971100184;40177.19645607071;40297.1940561193;40369.59630403717;1161.3960740414936;1196.6144081939594;1198.2451055834767;1213.1568559850996;1232.3037483821613;19401.126949287598;19792.307269245506;20115.899420502803;20587.4853128673;20972;29358.119256422342;29372.412551749272;29419;29435.41129177447;29530.55704164482;146641.26679366536;148266;148554;148693;148747;28584.428311434072;28851.7114828849;29688.109356719335;30791.84604077055;30883.536746948364;35808.820955895055;35987.64012359843;36184.81907590445;36187.09532261715;36559.81720091382;26352.868235658698;27653;27871.72128278691;28062;28187.295317617223;27161.72838271592;27467.31331716723;27498;28474.715252847207;28699.28251793722;30537.389252215275;30675.012248408457;30695;30712.385752284383;30786.076417707503;25948.61077083883;25998;26456;27057.729422706307;27144.321391965357;20650.896745516176;21436.785632144103;21567.352979410643;21576.892115539322;21665.241716539844 13:41:07 INFO - PID 21149 | |2;jquery.html;408.74861959894656;417.84957415330456;426.1498310869814;435.1601409280089;443.14473066980736;14958.850411495881;17017.489475315746;17782.466526004224;17817.198226079825;18126.18432170552;15938.681226375465;16261.51215463538;16300.429484968028;16561.83438165618;16885.915570422163;5542.584306177033;5545.085060964946;5581.972090139544;5649.49154576088;5769.076947688371;5336.146216605344;5536.141898005815;5641.8589535261535;5644.971775141139;5652.745626446799;5410.864728381803;5443.591730620199;5444.3194600674915;5449.754761035763;5478.424765399635;5353.812616558441;5361.061814182542;5416.539594134523;5446.591505637073;5458.344998600173;4917.901641967141;4937.1606826839525;4965.82619608312;4978.303037574742;4980.452150263504;21598.89200553987;21928.561428771496;21982.34052978413;22070.33788986317;22077.779222207733;1590.809102907647;1632.6653036127566;1657.8342165783445;1658.3118006027485;1664.1845495707137;14026.509072182527;14083.647908802259;14214.644633884132;14690.853091469162;14978.700425991528;1960.5196726802026;2015.032784263547;2033.0343087033689;2038.5617092325222;2039.5818857134252;88663;88704.55647721785;89593.55203223941;90072.54963725204;93591.53204234003;11002.284851484628;11022.50398732059;11131.053860421955;11213.3832639204;11375.431228438545;15480.690386192213;15490.30293636789;15531.611709707347;15566.143862087467;15599.766003509729;6851.45188384928;6861.656917154122;7014.368706816411;7017.473689473208;7065.89401158983;6052.969735151384;6072;6119.1988275525155;6275.090111933744;6302.8424289392215;7151.89272160918;7158.4273258140265;7168.211496735355;7234.457415693844;7309.853802924018;2097.40224036152;2102.8422868284633;2111.862728922615;2117.269542008005;2232.0290673557056;848.3510114762212;888.6756333938066;889.226373055446;890.0654312971354;918.389271134688;17377;17407.82592174062;17891.642167156584;18081;18338.266469341077;870.3950754225752;879.8900137482815;881.9338549608805;887.2680038967877;898.6989358564823;9383.390079644802;9684.661036863676;9979.850302245472;9999.900000999896;10042.14641755459;322215;323043;325034;332442;335217;76470.08824779425;76575;77547.83678244831;77822.2217777815;77985.22014779893;1019.6788011776415;1040.7190058684114;1062.39443517196;1067.7277294289906;1068.1454836131063;15152.242387880782;15165.393384264506;15770;17862.642747144724;19177.232910683415;37136.442953356265;38717.6128238714;38778.4183237246;39054;39379.212415752096;46137;46295.53704462912;46351;47606.761966189944;48917.75541122414;8557.101504342203;8760.912390876265;8767.123287671437;8855.291576673979;9039.774005649911;13201;13560.728785424433;13578.253196073916;13651.795223071464;13904.930475347963;11264.493097810455;11324.150688698215;11518.53925842957;11635.127365447795;11645.126615503701;10799;10862.565497380332;10866.728331791768;11005.834912476159;11031.393273370042;11531.711707207387;11577.305361678325;11607.477663504993;11624.6512604622;12035.879641203475;8592.828143437222;8646.78383040429;8725.25835303981;8820.603072861864;8881.777955551162;11447.713807154887;11507.769844603228;11610.24533405326;11843.940780296043;11970.46132924038 13:41:07 INFO - PID 21149 | |3;mootools.html;1240.2496489623777;1294.2364005236914;1299.8310219671441;1300.362822217114;1305.3016636099685;9323.254139668827;9727.756806079851;9740.659076932308;9888.950555247231;10134.189264858813;10135.695929122137;10342;10344.120749736281;10354.171666266699;10356.896431035688;2183.1267493002847;2206.933791986235;2208.845380823343;2219.289827255279;2224.443889027743;2095.4028101990934;2169.4142581502983;2181.7818218178213;2183.257692384589;2191.0468946008536;2193.2104442400723;2194.7366316042016;2217.4678077261424;2225.4547635829163;2230.631945728953;2140.625390556654;2157.6224160771803;2159.5572907553915;2167.014008626087;2169.208238992764;2068.2967790950997;2083.510375061859;2162.1891790578534;2219.5671843990426;2233.4416395901026;9721.17370023549;10013.699589012342;10015.198784097327;10021.348612340174;10027.448490333029;5151.201563757623;5326.733663316819;5331.466853314676;5344.91982620261;5349.384820745586;3150.9684903150905;3341.8496167672515;3394.2702319001532;3441.7590768646205;3469.2367679110807;1080.978380432387;1110.5557776889227;1115.4695389093508;1133.2520536445988;1134.3307448605362;14314.42742290307;14542.34559444817;14570.125792452487;14652.706945861022;14729.484468043567;4852.393450818648;5034.572061374824;5198.662086964411;5207.0366982108435;5209.817656382084;12264.448099835528;12298.754024919452;12312.569060082855;12330.691732706755;12349.382530873421;5505.752241149158;5533.170024496358;5537.778488860481;5552.194931734956;5554.055810512223;4746.477887432379;4816.783244753994;4887.511248875155;4918.508149185053;4959.776810043557;3539.531094595714;3716.2381711749026;3735.589085200626;3739.1586892949413;3759.1166075972124;1100.998091736516;1101.1521128730833;1109.7114750164853;1112.8831472695413;1126.0372381613765;658.2594581096266;669.2404121322335;674.0798809624924;693.1958927643909;700.6811900585221;4872.074305881871;4901.828436004723;4978.502149784992;4996.7501624918605;5097.388313402415;550.4577990679178;552.9087700529368;553.8559974406684;555.6249531566177;557.3479029535372;3134.655187929326;3182.7612929030415;3353.496975453653;3387.796732196076;3487.145649315883;12098.213616114925;12355.6911077222;12599.18105323151;12615.476904618929;12709.491620335268;12391.566295179626;12588.370581471074;12596.55912043074;12633.747325053448;12688.238705677504;6962.199347075049;7157.498975071695;7227.385672217921;7249.31131542492;7308;5449.12813949782;5481.698506582176;5488.670679759227;5632.85917852057;5743.655380677173;10860.402677852479;11082.16883733707;11224.94387528057;11327.093832493545;11479.540818367172;11664.241824281395;11710.414479276173;11857.288562686266;11913.82129268079;11925.807419258004;7204.423646108194;7221.205667376479;7239.384652304613;7275.381592564691;7301.379382752313;8975.820483590422;9342.112499312554;9370.34407591462;9384.483853387856;9399.10708482693;7360.631968401452;7389.556626602421;7512.5492470451945;7542.132654744555;7678.884816727642;7540.17058123595;7607.885881711668;7617.047869016373;7660.846783064196;7679.19368466303;6611.239707433707;6645.401913827779;6694.665266736741;6738.180691213247;6745.831354215988;4905.754712264301;4976.129177394014;5032.974835125801;5071.188609822559;5243.292155558951;4718.551737584924;5010.348654674869;5247.4490178530705;5313.601479889101;5350.250964864844 13:41:07 INFO - PID 21149 | |4;prototype.html;376.74004936593747;392.8467897519967;398.63524874739613;400.96591789697874;401.0155069304857;5408.702521361323;5546.584006199531;5562.610617256789;5612.747426365808;5620.269364982551;5284.920726189111;5353.7590808413615;5374.113271310229;5385.730713464321;5415;4132.739514448092;4132.834686612532;4137.524184718758;4140.130572579762;4143.585641435862;4003.819828107742;4123.484564429446;4140.461739973799;4150.08698086422;4154.023804405962;4077.816498257571;4084.14233011068;4094.7338423002557;4097.528784189826;4114.403411505345;4083.8979025524304;4095.2219078375015;4102.958970410287;4118.567550407209;4126.502112697174;3605.242898991215;3612.6929211017095;3626.7642603230706;3628.056705256652;3629.9291708945925;5211.765470553834;5277.920831187535;5278.947210527922;5303;5348.652337598043;4801.68789028712;4814.253790662453;4828.299896515021;4834.709917404932;4839.830605928775;5465.240053772819;5724.8282551523525;5749.022666146765;5751.654900705971;5776.59563830532;3982.4026396040535;3986.880393588197;4011.6991225657903;4018.4374187613757;4036.0717035081802;5931.525477961753;6018.428249316308;6022.434167116581;6089.725962331706;6090.330063693034;4081.6122468365456;4082.6937979651643;4093.5087789465456;4104;4125.319322311845;4147.958520414818;4150.460440142762;4165.416841642173;4186.120914607905;4188.225178342016;4713.410823647044;4779.235322348408;4806.567408933143;4824.831130910401;4828.420589529279;5745.6552606843725;5765.654060756368;5773.24947756789;5775.364709881909;5777.508911742465;1425.1235490173676;1440.7118576284786;1443.4009885897444;1450.2023886862185;1450.9056911300731;935.0696057422907;957.7653474898694;961.7643677299106;967.5500892085214;976.9853452198223;4920.704757714549;4940.987097644974;4957.157283261854;4979.278004689299;5002.624803139779;5934.1692163097205;5951.404859514014;5964.761409543569;5968.582199246011;5975.671338076448;4783.95216047842;4952.331435256267;4970.030843985461;4977.452480227172;4979.726115063634;3136.247300647828;3183.0450864740487;3184.26761844777;3192.4413227685063;3202.3115030268605;5449.6730196188355;5563.554915606742;5570.108782594765;5595;5596.804111856147;6086.2087928569;6128.662923539248;6132.080187971751;6168.9691551542855;6170.074488826712;5543.25166102571;5546.63946843462;5554.6944918029085;5583.302087239095;5585.69278689676;5913.34953155144;5948.583599148018;5984.730687119003;5997.280326360865;6006.969965150146;5869.706514674163;5906.346223057551;5911.438413350725;5940.643561386158;5940.940590594038;5402.378726446352;5467.289252397163;5505.018193450434;5527.479943015542;5539.7230138492105;4072.572379900068;4100.118474527991;4114.732542384735;4121.340585506305;4124.793760311913;5892.850894075614;5991.310999235144;6030.728617212324;6038.365971572922;6039.4262545058145;5733.684647344436;5757.481826635623;5760.884782304414;5768.192453056659;5801.822687664874;5751.223584816164;5760.596758226884;5792.478676919098;5812.488752924186;5818.592698511064;5602.803901863415;5655.066913959316;5712.828615141552;5721.971390143022;5723.198752174782;5826.155207494805;5829.598653016945;5835.623282538097;5843.7370318336625;5868.3251426086545;5444.156155795858;5506.889862202814;5596.916046259391;5671.206031155724;5674.404187560247 13:41:07 INFO - PID 21149 | |5;yui.html;713.0872483221478;733.1349008170357;755.0222461911824;755.3277582951173;778.3889646627397;10874.238803283773;11773.529058837657;12791.104622676405;13587.18476891386;13691.178529288238;14305.284735763196;14451.132932024086;14883.553493395215;14935.477258295934;15021.098734075964;821.6631181215718;831.4969443486694;831.9417640765149;833.6498670558381;835.8620827563475;894.6645008121955;899.0245583541865;902.2781774580342;904.3669431398015;905.483874191711;929.8605209218604;930.888293404789;931.0131260863473;932.9860052099224;934.4626839567276;918.5040078357679;920.9125133112343;922.524899676667;922.6540047482194;934.1825902335456;679.120538902118;679.2019377231733;681.0839420978775;683.9452843772486;691.2258270736756;12154.5745898894;12415;12508.49966001359;13557.932210338886;13624.727505449835;14620.488282910153;14673.192974386404;14704.705905881823;15022.399104035825;15060;11654.125940554492;11782.764344713143;11788.764224715458;11854.644360669108;12269.141160118796;2863.3700585871075;2869.913902582926;2870.7703383729254;2881.2652773542613;2883.8269703817627;59245;59825;59923.101153482734;60695;61390.386096138915;11915.40422978865;11989.160758746979;12357.443915023845;12359.022556390933;12383.071269654813;21324.14703411877;21548.892255538623;21904.12383504642;21949.341519754435;22004.33986980361;5679.2333035040565;5823.2429784128635;5824.767009319665;5846.064629659234;5890.4993075589055;2814.352698879269;2825.632667753179;2828.3212029112865;2841.8294902305515;2858.285428642839;3275.7870738401925;3325.584301962255;3334.733221342287;3359.3449277391164;3454.516367708523;717.7810767715897;721.231888039247;721.4516967105038;728.0898876404494;729.5002922997763;555.9471850174227;588.2088590845307;588.8204097750141;592.0881841963414;603.6860832367145;9021.864672029924;9103.681371151977;9456.8581471278;9636.277279204087;9946.353487023465;546.7484956919782;554.7060058169177;561.4638020690231;564.4271064869162;582.0367292131529;4058.7564746115327;4207.768572728468;4214.557471465513;4316.201502722007;4316.6546676265825;59513.053212329345;59952;60157.699211504536;60313.39686603078;61921.38078619156;54306.18540721892;54465;54741;55167.448325517034;56425.71787141038;48514.75742621264;48728.02543949101;49265.50734492609;49357.25964110541;50770.74614626977;8568.443051201652;8586.939134607774;8677.652893884175;8717.171868672465;8768.78078048054;25274.74725252724;25303.74696253014;25538.233852984442;25723.614145787455;26623.600645990715;30540;30654.693453066076;30749.385012300078;31175;31212.375752484368;10400.58397664085;10530;10573.841392378967;10598.099161571352;10636.149108071491;14302.141871487744;14349.139051656517;14847.40610375573;15055;15237.23813809283;13347.199168049949;13623.931880340535;13839.169649821042;13879.79180312276;14135.858641413453;12719.173253738478;13075.673108172372;13139.14595551286;13209.537666181637;13354.065215434826;12112.515499379926;12137;12234.75530489403;12696.936515317364;12909.35453227316;8941.105889411007;8967.461952282623;9165.908340916505;9284.860727089233;9685.079917407835;10276.691699249035;10333.793324133625;10385.844212336971;11006.174536909924;11281.71795705114 13:41:07 INFO - PID 21149 | __end_tp_report 13:41:07 INFO - PID 21149 | __start_cc_report 13:41:07 INFO - PID 21149 | _x_x_mozilla_cycle_collect,274 13:41:07 INFO - PID 21149 | __end_cc_report 13:41:07 INFO - PID 21149 | __startTimestamp1495485667854__endTimestamp 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | ------- Summary: start ------- 13:41:07 INFO - PID 21149 | Number of tests: 6 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | [#0] dojo.html Cycles:165 Average:5135.97 Median:5266.53 stddev:600.51 (11.4%) stddev-sans-first:571.14 13:41:07 INFO - PID 21149 | Values: 2700.2 2705.3 2740.8 2750.1 2762.0 5173.0 5208.6 5251.7 5257.9 5269.4 5175.5 5204.9 5216.9 5241.1 5296.8 4602.4 4615.3 4620.0 4631.9 4706.2 4680.4 4688.4 4707.5 4721.1 4725.2 4590.3 4601.6 4645.3 4657.4 4685.1 4671.1 4677.1 4682.3 4689.6 4717.5 4583.5 4633.2 4634.0 4669.4 4706.3 5071.9 5100.5 5186.2 5206.6 5251.9 5612.4 5617.8 5634.5 5662.5 5703.9 5671.3 5671.4 5683.9 5685.9 5697.7 5172.6 5235.9 5244.0 5257.9 5266.5 5763.3 5787.8 5802.9 5811.2 5821.0 5554.7 5612.8 5615.8 5615.8 5636.5 5551.5 5624.4 5627.5 5635.1 5640.4 5604.7 5605.9 5606.8 5607.2 5612.1 5521.8 5608.5 5611.0 5616.9 5617.1 4621.6 4640.7 4677.1 4695.5 4699.9 3992.9 4012.8 4015.9 4018.3 4051.8 4763.1 4768.0 4770.3 4803.8 4805.6 5530.2 5568.5 5582.5 5613.6 5643.9 4744.6 4775.9 4776.1 4797.0 4826.0 4938.2 4947.5 4974.2 4975.2 4993.2 5142.5 5241.5 5245.3 5250.2 5289.2 5482.0 5493.9 5535.8 5545.9 5560.6 5112.3 5145.1 5157.2 5223.9 5232.6 5477.1 5543.1 5552.2 5557.8 5558.0 5524.0 5559.4 5627.7 5633.1 5633.1 5456.6 5463.2 5492.3 5494.5 5499.1 5469.6 5480.9 5492.5 5554.1 5555.8 5363.9 5369.8 5390.4 5423.8 5433.1 5467.8 5483.5 5489.9 5534.6 5541.3 5111.3 5287.3 5308.3 5323.3 5356.9 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | [#1] ext.html Cycles:180 Average:30297.28 Median:3083.14 stddev:41658.38 (1351.2%) stddev-sans-first:41715.81 13:41:07 INFO - PID 21149 | Values: 662.5 721.1 745.4 1071.0 1073.1 32292.2 32876.8 33105.8 33237.8 33351.7 34913.0 35233.8 35252.3 35376.5 35439.8 6813.5 6926.7 6941.0 6943.5 7043.0 6982.3 7077.2 7081.9 7089.8 7090.9 7042.9 7055.0 7097.2 7112.0 7114.1 7045.7 7060.0 7071.4 7082.0 7088.4 6668.4 6677.9 6680.0 6686.7 6689.4 31647.2 31740.2 31848.0 31884.4 32095.4 3051.4 3063.1 3080.8 3085.5 3088.8 24383.6 24419.1 24601.3 24625.5 24655.8 3040.9 3077.9 3091.9 3094.7 3100.1 146319.0 146477.0 147601.0 154445.2 155198.0 39068.6 39257.0 39341.8 39375.2 39384.0 41176.2 41230.4 41239.8 41278.4 41369.8 10862.6 11004.4 11019.0 11040.2 11052.4 8552.1 8593.5 8596.8 8603.5 8624.3 12582.4 12669.4 12679.0 12757.9 12841.6 5244.0 5245.9 5315.7 5362.6 5373.9 867.3 871.4 882.8 885.5 911.6 20019.6 20769.6 21107.7 21155.8 21369.3 933.6 943.5 943.9 969.9 995.1 10558.0 11064.3 11145.9 11213.0 11304.8 182187.0 183091.0 183181.0 183860.0 183893.0 39761.2 40057.8 40177.2 40297.2 40369.6 1161.4 1196.6 1198.2 1213.2 1232.3 19401.1 19792.3 20115.9 20587.5 20972.0 29358.1 29372.4 29419.0 29435.4 29530.6 146641.3 148266.0 148554.0 148693.0 148747.0 28584.4 28851.7 29688.1 30791.8 30883.5 35808.8 35987.6 36184.8 36187.1 36559.8 26352.9 27653.0 27871.7 28062.0 28187.3 27161.7 27467.3 27498.0 28474.7 28699.3 30537.4 30675.0 30695.0 30712.4 30786.1 25948.6 25998.0 26456.0 27057.7 27144.3 20650.9 21436.8 21567.4 21576.9 21665.2 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | [#2] jquery.html Cycles:180 Average:23741.26 Median:186176.72 stddev:55008.60 (29.5%) stddev-sans-first:55135.02 13:41:07 INFO - PID 21149 | Values: 408.7 417.8 426.1 435.2 443.1 14958.9 17017.5 17782.5 17817.2 18126.2 15938.7 16261.5 16300.4 16561.8 16885.9 5542.6 5545.1 5582.0 5649.5 5769.1 5336.1 5536.1 5641.9 5645.0 5652.7 5410.9 5443.6 5444.3 5449.8 5478.4 5353.8 5361.1 5416.5 5446.6 5458.3 4917.9 4937.2 4965.8 4978.3 4980.5 21598.9 21928.6 21982.3 22070.3 22077.8 1590.8 1632.7 1657.8 1658.3 1664.2 14026.5 14083.6 14214.6 14690.9 14978.7 1960.5 2015.0 2033.0 2038.6 2039.6 88663.0 88704.6 89593.6 90072.5 93591.5 11002.3 11022.5 11131.1 11213.4 11375.4 15480.7 15490.3 15531.6 15566.1 15599.8 6851.5 6861.7 7014.4 7017.5 7065.9 6053.0 6072.0 6119.2 6275.1 6302.8 7151.9 7158.4 7168.2 7234.5 7309.9 2097.4 2102.8 2111.9 2117.3 2232.0 848.4 888.7 889.2 890.1 918.4 17377.0 17407.8 17891.6 18081.0 18338.3 870.4 879.9 881.9 887.3 898.7 9383.4 9684.7 9979.9 9999.9 10042.1 322215.0 323043.0 325034.0 332442.0 335217.0 76470.1 76575.0 77547.8 77822.2 77985.2 1019.7 1040.7 1062.4 1067.7 1068.1 15152.2 15165.4 15770.0 17862.6 19177.2 37136.4 38717.6 38778.4 39054.0 39379.2 46137.0 46295.5 46351.0 47606.8 48917.8 8557.1 8760.9 8767.1 8855.3 9039.8 13201.0 13560.7 13578.3 13651.8 13904.9 11264.5 11324.2 11518.5 11635.1 11645.1 10799.0 10862.6 10866.7 11005.8 11031.4 11531.7 11577.3 11607.5 11624.7 12035.9 8592.8 8646.8 8725.3 8820.6 8881.8 11447.7 11507.8 11610.2 11843.9 11970.5 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | [#3] mootools.html Cycles:180 Average:6055.87 Median:3627.88 stddev:3930.96 (108.4%) stddev-sans-first:3925.33 13:41:07 INFO - PID 21149 | Values: 1240.2 1294.2 1299.8 1300.4 1305.3 9323.3 9727.8 9740.7 9889.0 10134.2 10135.7 10342.0 10344.1 10354.2 10356.9 2183.1 2206.9 2208.8 2219.3 2224.4 2095.4 2169.4 2181.8 2183.3 2191.0 2193.2 2194.7 2217.5 2225.5 2230.6 2140.6 2157.6 2159.6 2167.0 2169.2 2068.3 2083.5 2162.2 2219.6 2233.4 9721.2 10013.7 10015.2 10021.3 10027.4 5151.2 5326.7 5331.5 5344.9 5349.4 3151.0 3341.8 3394.3 3441.8 3469.2 1081.0 1110.6 1115.5 1133.3 1134.3 14314.4 14542.3 14570.1 14652.7 14729.5 4852.4 5034.6 5198.7 5207.0 5209.8 12264.4 12298.8 12312.6 12330.7 12349.4 5505.8 5533.2 5537.8 5552.2 5554.1 4746.5 4816.8 4887.5 4918.5 4959.8 3539.5 3716.2 3735.6 3739.2 3759.1 1101.0 1101.2 1109.7 1112.9 1126.0 658.3 669.2 674.1 693.2 700.7 4872.1 4901.8 4978.5 4996.8 5097.4 550.5 552.9 553.9 555.6 557.3 3134.7 3182.8 3353.5 3387.8 3487.1 12098.2 12355.7 12599.2 12615.5 12709.5 12391.6 12588.4 12596.6 12633.7 12688.2 6962.2 7157.5 7227.4 7249.3 7308.0 5449.1 5481.7 5488.7 5632.9 5743.7 10860.4 11082.2 11224.9 11327.1 11479.5 11664.2 11710.4 11857.3 11913.8 11925.8 7204.4 7221.2 7239.4 7275.4 7301.4 8975.8 9342.1 9370.3 9384.5 9399.1 7360.6 7389.6 7512.5 7542.1 7678.9 7540.2 7607.9 7617.0 7660.8 7679.2 6611.2 6645.4 6694.7 6738.2 6745.8 4905.8 4976.1 5033.0 5071.2 5243.3 4718.6 5010.3 5247.4 5313.6 5350.3 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | [#4] prototype.html Cycles:180 Average:4746.12 Median:5411.85 stddev:1407.17 (26.0%) stddev-sans-first:1372.37 13:41:07 INFO - PID 21149 | Values: 376.7 392.8 398.6 401.0 401.0 5408.7 5546.6 5562.6 5612.7 5620.3 5284.9 5353.8 5374.1 5385.7 5415.0 4132.7 4132.8 4137.5 4140.1 4143.6 4003.8 4123.5 4140.5 4150.1 4154.0 4077.8 4084.1 4094.7 4097.5 4114.4 4083.9 4095.2 4103.0 4118.6 4126.5 3605.2 3612.7 3626.8 3628.1 3629.9 5211.8 5277.9 5278.9 5303.0 5348.7 4801.7 4814.3 4828.3 4834.7 4839.8 5465.2 5724.8 5749.0 5751.7 5776.6 3982.4 3986.9 4011.7 4018.4 4036.1 5931.5 6018.4 6022.4 6089.7 6090.3 4081.6 4082.7 4093.5 4104.0 4125.3 4148.0 4150.5 4165.4 4186.1 4188.2 4713.4 4779.2 4806.6 4824.8 4828.4 5745.7 5765.7 5773.2 5775.4 5777.5 1425.1 1440.7 1443.4 1450.2 1450.9 935.1 957.8 961.8 967.6 977.0 4920.7 4941.0 4957.2 4979.3 5002.6 5934.2 5951.4 5964.8 5968.6 5975.7 4784.0 4952.3 4970.0 4977.5 4979.7 3136.2 3183.0 3184.3 3192.4 3202.3 5449.7 5563.6 5570.1 5595.0 5596.8 6086.2 6128.7 6132.1 6169.0 6170.1 5543.3 5546.6 5554.7 5583.3 5585.7 5913.3 5948.6 5984.7 5997.3 6007.0 5869.7 5906.3 5911.4 5940.6 5940.9 5402.4 5467.3 5505.0 5527.5 5539.7 4072.6 4100.1 4114.7 4121.3 4124.8 5892.9 5991.3 6030.7 6038.4 6039.4 5733.7 5757.5 5760.9 5768.2 5801.8 5751.2 5760.6 5792.5 5812.5 5818.6 5602.8 5655.1 5712.8 5722.0 5723.2 5826.2 5829.6 5835.6 5843.7 5868.3 5444.2 5506.9 5596.9 5671.2 5674.4 13:41:07 INFO - PID 21149 | 13:41:07 INFO - PID 21149 | [#5] yui.html Cycles:180 Average:14188.21 Median:4133.26 stddev:16641.96 (402.6%) stddev-sans-first:16657.88 13:41:07 INFO - PID 21149 | Values: 713.1 733.1 755.0 755.3 778.4 10874.2 11773.5 12791.1 13587.2 13691.2 14305.3 14451.1 14883.6 14935.5 15021.1 821.7 831.5 831.9 833.6 835.9 894.7 899.0 902.3 904.4 905.5 929.9 930.9 931.0 933.0 934.5 918.5 920.9 922.5 922.7 934.2 679.1 679.2 681.1 683.9 691.2 12154.6 12415.0 12508.5 13557.9 13624.7 14620.5 14673.2 14704.7 15022.4 15060.0 11654.1 11782.8 11788.8 11854.6 12269.1 2863.4 2869.9 2870.8 2881.3 2883.8 59245.0 59825.0 59923.1 60695.0 61390.4 11915.4 11989.2 12357.4 12359.0 12383.1 21324.1 21548.9 21904.1 21949.3 22004.3 5679.2 5823.2 5824.8 5846.1 5890.5 2814.4 2825.6 2828.3 2841.8 2858.3 3275.8 3325.6 3334.7 3359.3 3454.5 717.8 721.2 721.5 728.1 729.5 555.9 588.2 588.8 592.1 603.7 9021.9 9103.7 9456.9 9636.3 9946.4 546.7 554.7 561.5 564.4 582.0 4058.8 4207.8 4214.6 4316.2 4316.7 59513.1 59952.0 60157.7 60313.4 61921.4 54306.2 54465.0 54741.0 55167.4 56425.7 48514.8 48728.0 49265.5 49357.3 50770.7 8568.4 8586.9 8677.7 8717.2 8768.8 25274.7 25303.7 25538.2 25723.6 26623.6 30540.0 30654.7 30749.4 31175.0 31212.4 10400.6 10530.0 10573.8 10598.1 10636.1 14302.1 14349.1 14847.4 15055.0 15237.2 13347.2 13623.9 13839.2 13879.8 14135.9 12719.2 13075.7 13139.1 13209.5 13354.1 12112.5 12137.0 12234.8 12696.9 12909.4 8941.1 8967.5 9165.9 9284.9 9685.1 10276.7 10333.8 10385.8 11006.2 11281.7 13:41:07 INFO - PID 21149 | -------- Summary: end -------- 13:41:07 INFO - PID 21149 | 13:41:08 INFO - TEST-INFO | 21149: exit 0 13:41:08 INFO - TEST-OK | dromaeo_css | took 1118741ms 13:41:08 INFO - TEST-START | kraken 13:41:08 INFO - operating with platform_type : linux_ 13:41:08 INFO - Initialising browser for kraken test... 13:41:08 INFO - TEST-INFO | started process 21573 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7l6DBo/profile http://localhost:35888/getInfo.html) 13:41:09 INFO - PID 21573 | JavaScript warning: resource://gre/modules/addons/XPIProvider.jsm, line 2978: String.localeCompare is deprecated; use String.prototype.localeCompare instead 13:41:12 INFO - PID 21573 | __metrics Screen width/height:1600/1200 13:41:12 INFO - PID 21573 | colorDepth:24 13:41:12 INFO - PID 21573 | Browser inner width/height: 1024/695 13:41:12 INFO - PID 21573 | __metrics 13:41:15 INFO - TEST-INFO | 21573: exit 0 13:41:15 INFO - Browser initialized. 13:41:15 INFO - Running cycle 1/1 for kraken test... 13:41:15 INFO - TEST-INFO | started process 21752 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7l6DBo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:41:26 INFO - PID 21752 | RSS: Main: 169885696 13:41:26 INFO - PID 21752 | 13:41:29 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35888/tests/kraken/driver.html?testName=audio-beat-detection) 13:41:30 INFO - PID 21752 | RSS: Main: 174514176 13:41:30 INFO - PID 21752 | 13:41:33 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35888/tests/kraken/driver.html?testName=audio-dft) 13:41:33 INFO - PID 21752 | RSS: Main: 174034944 13:41:33 INFO - PID 21752 | 13:41:36 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35888/tests/kraken/driver.html?testName=audio-fft) 13:41:37 INFO - PID 21752 | RSS: Main: 169193472 13:41:37 INFO - PID 21752 | 13:41:39 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35888/tests/kraken/driver.html?testName=audio-oscillator) 13:41:39 INFO - PID 21752 | RSS: Main: 169992192 13:41:39 INFO - PID 21752 | 13:41:42 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35888/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:41:42 INFO - PID 21752 | RSS: Main: 170004480 13:41:42 INFO - PID 21752 | 13:41:45 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35888/tests/kraken/driver.html?testName=imaging-darkroom) 13:41:46 INFO - PID 21752 | RSS: Main: 173662208 13:41:46 INFO - PID 21752 | 13:41:50 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35888/tests/kraken/driver.html?testName=imaging-desaturate) 13:41:50 INFO - PID 21752 | RSS: Main: 171888640 13:41:50 INFO - PID 21752 | 13:41:53 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35888/tests/kraken/driver.html?testName=json-parse-financial) 13:41:54 INFO - PID 21752 | RSS: Main: 172646400 13:41:54 INFO - PID 21752 | 13:41:55 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35888/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:41:56 INFO - PID 21752 | RSS: Main: 172605440 13:41:56 INFO - PID 21752 | 13:41:58 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:41:59 INFO - PID 21752 | RSS: Main: 172503040 13:41:59 INFO - PID 21752 | 13:42:01 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:42:01 INFO - PID 21752 | RSS: Main: 172683264 13:42:01 INFO - PID 21752 | 13:42:04 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:42:05 INFO - PID 21752 | RSS: Main: 172769280 13:42:05 INFO - PID 21752 | 13:42:08 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:42:09 INFO - PID 21752 | RSS: Main: 172650496 13:42:09 INFO - PID 21752 | 13:42:10 INFO - PID 21752 | Cycle 1(1): loaded http://localhost:35888/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35888/tests/kraken/driver.html?testName=ai-astar) 13:42:11 INFO - PID 21752 | RSS: Main: 174047232 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | __start_tp_report 13:42:11 INFO - PID 21752 | _x_x_mozilla_page_load 13:42:11 INFO - PID 21752 | _x_x_mozilla_page_load_details 13:42:11 INFO - PID 21752 | |i|pagename|runs| 13:42:11 INFO - PID 21752 | |0;ai-astar;105;115;114;114;114;111;112;112;112;114 13:42:11 INFO - PID 21752 | |1;audio-beat-detection;157;123;130;169;125;125;125;126;147;123 13:42:11 INFO - PID 21752 | |2;audio-dft;162;162;166;164;162;166;169;167;164;166 13:42:11 INFO - PID 21752 | |3;audio-fft;76;76;75;103;76;75;75;75;95;77 13:42:11 INFO - PID 21752 | |4;audio-oscillator;83;82;104;89;84;82;101;83;84;108 13:42:11 INFO - PID 21752 | |5;imaging-gaussian-blur;114;115;114;118;114;113;114;114;119;117 13:42:11 INFO - PID 21752 | |6;imaging-darkroom;153;151;151;151;152;152;151;152;150;151 13:42:11 INFO - PID 21752 | |7;imaging-desaturate;95;95;99;95;99;95;95;95;95;95 13:42:11 INFO - PID 21752 | |8;json-parse-financial;54;56;58;55;56;58;56;55;55;56 13:42:11 INFO - PID 21752 | |9;json-stringify-tinderbox;58;58;58;59;58;57;58;61;57;57 13:42:11 INFO - PID 21752 | |10;stanford-crypto-aes;82;82;83;82;82;82;83;83;83;88 13:42:11 INFO - PID 21752 | |11;stanford-crypto-ccm;136;143;138;132;133;135;137;133;190;134 13:42:11 INFO - PID 21752 | |12;stanford-crypto-pbkdf2;195;184;195;207;202;184;204;183;189;191 13:42:11 INFO - PID 21752 | |13;stanford-crypto-sha256-iterative;82;73;76;75;75;73;75;77;72;72 13:42:11 INFO - PID 21752 | __end_tp_report 13:42:11 INFO - PID 21752 | __start_cc_report 13:42:11 INFO - PID 21752 | _x_x_mozilla_cycle_collect,755 13:42:11 INFO - PID 21752 | __end_cc_report 13:42:11 INFO - PID 21752 | __startTimestamp1495485731185__endTimestamp 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | ------- Summary: start ------- 13:42:11 INFO - PID 21752 | Number of tests: 14 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#0] ai-astar Cycles:10 Average:112.30 Median:114.00 stddev:2.87 (2.5%) stddev-sans-first:1.36 13:42:11 INFO - PID 21752 | Values: 105.0 115.0 114.0 114.0 114.0 111.0 112.0 112.0 112.0 114.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#1] audio-beat-detection Cycles:10 Average:135.00 Median:128.00 stddev:16.59 (13.0%) stddev-sans-first:15.57 13:42:11 INFO - PID 21752 | Values: 157.0 123.0 130.0 169.0 125.0 125.0 125.0 126.0 147.0 123.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#2] audio-dft Cycles:10 Average:164.80 Median:166.00 stddev:2.39 (1.4%) stddev-sans-first:2.32 13:42:11 INFO - PID 21752 | Values: 162.0 162.0 166.0 164.0 162.0 166.0 169.0 167.0 164.0 166.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#3] audio-fft Cycles:10 Average:80.30 Median:76.00 stddev:10.06 (13.2%) stddev-sans-first:10.54 13:42:11 INFO - PID 21752 | Values: 76.0 76.0 75.0 103.0 76.0 75.0 75.0 75.0 95.0 77.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#4] audio-oscillator Cycles:10 Average:90.00 Median:83.00 stddev:10.22 (12.3%) stddev-sans-first:10.52 13:42:11 INFO - PID 21752 | Values: 83.0 82.0 104.0 89.0 84.0 82.0 101.0 83.0 84.0 108.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#5] imaging-gaussian-blur Cycles:10 Average:115.20 Median:114.50 stddev:2.04 (1.8%) stddev-sans-first:2.12 13:42:11 INFO - PID 21752 | Values: 114.0 115.0 114.0 118.0 114.0 113.0 114.0 114.0 119.0 117.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#6] imaging-darkroom Cycles:10 Average:151.40 Median:151.50 stddev:0.84 (0.6%) stddev-sans-first:0.67 13:42:11 INFO - PID 21752 | Values: 153.0 151.0 151.0 151.0 152.0 152.0 151.0 152.0 150.0 151.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:95.00 stddev:1.69 (1.8%) stddev-sans-first:1.76 13:42:11 INFO - PID 21752 | Values: 95.0 95.0 99.0 95.0 99.0 95.0 95.0 95.0 95.0 95.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#8] json-parse-financial Cycles:10 Average:55.90 Median:56.00 stddev:1.29 (2.3%) stddev-sans-first:1.17 13:42:11 INFO - PID 21752 | Values: 54.0 56.0 58.0 55.0 56.0 58.0 56.0 55.0 55.0 56.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#9] json-stringify-tinderbox Cycles:10 Average:58.10 Median:58.00 stddev:1.20 (2.1%) stddev-sans-first:1.27 13:42:11 INFO - PID 21752 | Values: 58.0 58.0 58.0 59.0 58.0 57.0 58.0 61.0 57.0 57.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#10] stanford-crypto-aes Cycles:10 Average:83.00 Median:83.00 stddev:1.83 (2.2%) stddev-sans-first:1.90 13:42:11 INFO - PID 21752 | Values: 82.0 82.0 83.0 82.0 82.0 82.0 83.0 83.0 83.0 88.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#11] stanford-crypto-ccm Cycles:10 Average:141.10 Median:136.50 stddev:17.48 (12.8%) stddev-sans-first:18.44 13:42:11 INFO - PID 21752 | Values: 136.0 143.0 138.0 132.0 133.0 135.0 137.0 133.0 190.0 134.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:193.40 Median:195.00 stddev:8.73 (4.5%) stddev-sans-first:9.24 13:42:11 INFO - PID 21752 | Values: 195.0 184.0 195.0 207.0 202.0 184.0 204.0 183.0 189.0 191.0 13:42:11 INFO - PID 21752 | 13:42:11 INFO - PID 21752 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:75.00 Median:75.00 stddev:2.98 (4.0%) stddev-sans-first:1.79 13:42:11 INFO - PID 21752 | Values: 82.0 73.0 76.0 75.0 75.0 73.0 75.0 77.0 72.0 72.0 13:42:11 INFO - PID 21752 | -------- Summary: end -------- 13:42:11 INFO - PID 21752 | 13:42:12 INFO - TEST-INFO | 21752: exit 0 13:42:12 INFO - TEST-OK | kraken | took 63584ms 13:42:12 INFO - SUITE-END | took 1182s 13:42:12 INFO - Completed test suite (00:19:42) 13:42:12 INFO - javascript benchmark 13:42:12 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6579.8951247429395, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2700.189943017095, 2705.296622878051, 2740.8492532910695, 2750.1062154799683, 2762.0470937526547, 5173.0, 5208.557272631826, 5251.711155886434, 5257.947420525794, 5269.394019687732, 5175.482451754822, 5204.895902081956, 5216.9478305216935, 5241.10901146805, 5296.8146114885985, 4602.424696912894, 4615.3077038444335, 4620.0, 4631.884202894921, 4706.22347312693, 4680.391549098613, 4688.390509233812, 4707.482176960549, 4721.055788842245, 4725.196716558176, 4590.265557510782, 4601.585857272861, 4645.349651048856, 4657.417822772153, 4685.086408150412, 4671.089137618166, 4677.134730074947, 4682.29765535169, 4689.648276379251, 4717.457492388351, 4583.541645835423, 4633.212353899845, 4633.953660463386, 4669.41632295963, 4706.29405589161, 5071.8985620287385, 5100.5409513143995, 5186.222066689989, 5206.557442617382, 5251.921221181686, 5612.382637909826, 5617.831465056014, 5634.521065709419, 5662.518685911702, 5703.857403564944, 5671.262735844314, 5671.404502527216, 5683.857903552403, 5685.886282274373, 5697.658140511541, 5172.612054095883, 5235.895282094337, 5244.0, 5257.947420525746, 5266.526012658879, 5763.2507773989955, 5787.768489260467, 5802.941970580325, 5811.186433899257, 5821.0, 5554.666719996813, 5612.831615051555, 5615.803446879339, 5615.831525054255, 5636.549076073904, 5551.472610102114, 5624.409437009137, 5627.46539078795, 5635.0702134147405, 5640.435956404327, 5604.663720176803, 5605.915911261334, 5606.803761868315, 5607.243022191952, 5612.102063669793, 5521.806736764194, 5608.523275521545, 5611.018071837412, 5616.85957851057, 5617.129344951539, 4621.560951709582, 4640.721556706609, 4677.134730074947, 4695.460022097503, 4699.929501057487, 3992.8802135935966, 4012.7792971386853, 4015.8996025099605, 4018.3168861293652, 4051.7974101294817, 4763.118823017753, 4767.976160119178, 4770.332153498513, 4803.759812009385, 4805.591524720368, 5530.170474428868, 5568.49883510486, 5582.525485333711, 5613.578981576398, 5643.915341269884, 4744.572988431058, 4775.928361074587, 4776.09254241693, 4796.952030479651, 4826.0347930414055, 4938.209886418228, 4947.480514545993, 4974.228994505857, 4975.203967365204, 4993.201087825931, 5142.485751424828, 5241.50205730455, 5245.3181086460045, 5250.18622113573, 5289.2330612061805, 5481.972590137024, 5493.890122197614, 5535.806246781343, 5545.916811247916, 5560.5551555876245, 5112.284280200849, 5145.07388670043, 5157.174852023658, 5223.895522089613, 5232.581393488588, 5477.096279114061, 5543.113101903676, 5552.167174923794, 5557.833265002057, 5558.0, 5524.0, 5559.4162612926675, 5627.718614069362, 5633.0987042073075, 5633.126865335879, 5456.645318054314, 5463.153211252262, 5492.340919089735, 5494.450554944474, 5499.1476321170285, 5469.589780766538, 5480.917786233289, 5492.450754924475, 5554.1391084381985, 5555.777768889199, 5363.919541206963, 5369.758360873692, 5390.434004429479, 5423.810166644149, 5433.076377015996, 5467.808626698046, 5483.533899618577, 5489.890202195854, 5534.557235421237, 5541.33503979525, 5111.3355263815465, 5287.286216360742, 5308.320097495643, 5323.307969964035, 5356.892862142813], "value": 5092.636267471683, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [662.5395350231588, 721.1130309719045, 745.4446437404133, 1071.0146665068141, 1073.1414868105524, 32292.192695182603, 32876.83561582192, 33105.84129555466, 33237.83381083094, 33351.66648333516, 34913.0, 35233.82383088081, 35252.2949541009, 35376.51663992079, 35439.822800886024, 6813.488988325883, 6926.688299026556, 6941.0, 6943.479239057091, 7043.0, 6982.33667801558, 7077.221505634376, 7081.858362832741, 7089.8227544311285, 7090.929090709078, 7042.929570704278, 7054.964725176367, 7097.21930587635, 7112.0, 7114.075170227863, 7045.68294426752, 7059.9647001764915, 7071.36357727807, 7081.964590177067, 7088.397486213678, 6668.399844014013, 6677.899831502531, 6680.031395447633, 6686.732530698766, 6689.397954184098, 31647.20881977946, 31740.206494837585, 31848.0, 31884.36231275385, 32095.358092838247, 3051.3897220555755, 3063.0657649416917, 3080.799748016394, 3085.4754691702465, 3088.7528997680133, 24383.634245486333, 24419.14532991337, 24601.261962141165, 24625.507489850283, 24655.753442465706, 3040.9087727368214, 3077.8768849246003, 3091.938161236763, 3094.7060029297404, 3100.100970718489, 146319.0, 146477.0, 147601.0, 154445.22777386152, 155198.0, 39068.609313907065, 39257.0, 39341.803290983364, 39375.2124957505, 39384.0, 41176.176476470304, 41230.38154427686, 41239.84501937258, 41278.38082428766, 41369.79315103465, 10862.565497380174, 11004.449777511092, 11019.0, 11040.171987101, 11052.392118433563, 8552.144785521397, 8593.527355995355, 8596.78508037304, 8603.451378751884, 8624.266937310398, 12582.43379047945, 12669.366531673379, 12678.985681145487, 12757.936210318889, 12841.550545730855, 5244.0, 5245.947540524622, 5315.707636080053, 5362.597805164628, 5373.871486987777, 867.2584939876441, 871.3813192633302, 882.7925437522306, 885.5439448683933, 911.6034524981654, 20019.599608007757, 20769.58460830775, 21107.68338474924, 21155.78844211569, 21369.252076177258, 933.6125507914276, 943.5140902435252, 943.8631398447187, 969.9466529340813, 995.0646392391129, 10558.0, 11064.28082174656, 11145.944270278758, 11213.0, 11304.773904522028, 182187.0, 183091.0, 183181.0, 183860.0, 183893.0, 39761.2047759049, 40057.79971100184, 40177.19645607071, 40297.1940561193, 40369.59630403717, 1161.3960740414936, 1196.6144081939594, 1198.2451055834767, 1213.1568559850996, 1232.3037483821613, 19401.126949287598, 19792.307269245506, 20115.899420502803, 20587.4853128673, 20972.0, 29358.119256422342, 29372.412551749272, 29419.0, 29435.41129177447, 29530.55704164482, 146641.26679366536, 148266.0, 148554.0, 148693.0, 148747.0, 28584.428311434072, 28851.7114828849, 29688.109356719335, 30791.84604077055, 30883.536746948364, 35808.820955895055, 35987.64012359843, 36184.81907590445, 36187.09532261715, 36559.81720091382, 26352.868235658698, 27653.0, 27871.72128278691, 28062.0, 28187.295317617223, 27161.72838271592, 27467.31331716723, 27498.0, 28474.715252847207, 28699.28251793722, 30537.389252215275, 30675.012248408457, 30695.0, 30712.385752284383, 30786.076417707503, 25948.61077083883, 25998.0, 26456.0, 27057.729422706307, 27144.321391965357, 20650.896745516176, 21436.785632144103, 21567.352979410643, 21576.892115539322, 21665.241716539844], "value": 14318.372217355565, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [408.74861959894656, 417.84957415330456, 426.1498310869814, 435.1601409280089, 443.14473066980736, 14958.850411495881, 17017.489475315746, 17782.466526004224, 17817.198226079825, 18126.18432170552, 15938.681226375465, 16261.51215463538, 16300.429484968028, 16561.83438165618, 16885.915570422163, 5542.584306177033, 5545.085060964946, 5581.972090139544, 5649.49154576088, 5769.076947688371, 5336.146216605344, 5536.141898005815, 5641.8589535261535, 5644.971775141139, 5652.745626446799, 5410.864728381803, 5443.591730620199, 5444.3194600674915, 5449.754761035763, 5478.424765399635, 5353.812616558441, 5361.061814182542, 5416.539594134523, 5446.591505637073, 5458.344998600173, 4917.901641967141, 4937.1606826839525, 4965.82619608312, 4978.303037574742, 4980.452150263504, 21598.89200553987, 21928.561428771496, 21982.34052978413, 22070.33788986317, 22077.779222207733, 1590.809102907647, 1632.6653036127566, 1657.8342165783445, 1658.3118006027485, 1664.1845495707137, 14026.509072182527, 14083.647908802259, 14214.644633884132, 14690.853091469162, 14978.700425991528, 1960.5196726802026, 2015.032784263547, 2033.0343087033689, 2038.5617092325222, 2039.5818857134252, 88663.0, 88704.55647721785, 89593.55203223941, 90072.54963725204, 93591.53204234003, 11002.284851484628, 11022.50398732059, 11131.053860421955, 11213.3832639204, 11375.431228438545, 15480.690386192213, 15490.30293636789, 15531.611709707347, 15566.143862087467, 15599.766003509729, 6851.45188384928, 6861.656917154122, 7014.368706816411, 7017.473689473208, 7065.89401158983, 6052.969735151384, 6072.0, 6119.1988275525155, 6275.090111933744, 6302.8424289392215, 7151.89272160918, 7158.4273258140265, 7168.211496735355, 7234.457415693844, 7309.853802924018, 2097.40224036152, 2102.8422868284633, 2111.862728922615, 2117.269542008005, 2232.0290673557056, 848.3510114762212, 888.6756333938066, 889.226373055446, 890.0654312971354, 918.389271134688, 17377.0, 17407.82592174062, 17891.642167156584, 18081.0, 18338.266469341077, 870.3950754225752, 879.8900137482815, 881.9338549608805, 887.2680038967877, 898.6989358564823, 9383.390079644802, 9684.661036863676, 9979.850302245472, 9999.900000999896, 10042.14641755459, 322215.0, 323043.0, 325034.0, 332442.0, 335217.0, 76470.08824779425, 76575.0, 77547.83678244831, 77822.2217777815, 77985.22014779893, 1019.6788011776415, 1040.7190058684114, 1062.39443517196, 1067.7277294289906, 1068.1454836131063, 15152.242387880782, 15165.393384264506, 15770.0, 17862.642747144724, 19177.232910683415, 37136.442953356265, 38717.6128238714, 38778.4183237246, 39054.0, 39379.212415752096, 46137.0, 46295.53704462912, 46351.0, 47606.761966189944, 48917.75541122414, 8557.101504342203, 8760.912390876265, 8767.123287671437, 8855.291576673979, 9039.774005649911, 13201.0, 13560.728785424433, 13578.253196073916, 13651.795223071464, 13904.930475347963, 11264.493097810455, 11324.150688698215, 11518.53925842957, 11635.127365447795, 11645.126615503701, 10799.0, 10862.565497380332, 10866.728331791768, 11005.834912476159, 11031.393273370042, 11531.711707207387, 11577.305361678325, 11607.477663504993, 11624.6512604622, 12035.879641203475, 8592.828143437222, 8646.78383040429, 8725.25835303981, 8820.603072861864, 8881.777955551162, 11447.713807154887, 11507.769844603228, 11610.24533405326, 11843.940780296043, 11970.46132924038], "value": 8835.659526571702, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1240.2496489623777, 1294.2364005236914, 1299.8310219671441, 1300.362822217114, 1305.3016636099685, 9323.254139668827, 9727.756806079851, 9740.659076932308, 9888.950555247231, 10134.189264858813, 10135.695929122137, 10342.0, 10344.120749736281, 10354.171666266699, 10356.896431035688, 2183.1267493002847, 2206.933791986235, 2208.845380823343, 2219.289827255279, 2224.443889027743, 2095.4028101990934, 2169.4142581502983, 2181.7818218178213, 2183.257692384589, 2191.0468946008536, 2193.2104442400723, 2194.7366316042016, 2217.4678077261424, 2225.4547635829163, 2230.631945728953, 2140.625390556654, 2157.6224160771803, 2159.5572907553915, 2167.014008626087, 2169.208238992764, 2068.2967790950997, 2083.510375061859, 2162.1891790578534, 2219.5671843990426, 2233.4416395901026, 9721.17370023549, 10013.699589012342, 10015.198784097327, 10021.348612340174, 10027.448490333029, 5151.201563757623, 5326.733663316819, 5331.466853314676, 5344.91982620261, 5349.384820745586, 3150.9684903150905, 3341.8496167672515, 3394.2702319001532, 3441.7590768646205, 3469.2367679110807, 1080.978380432387, 1110.5557776889227, 1115.4695389093508, 1133.2520536445988, 1134.3307448605362, 14314.42742290307, 14542.34559444817, 14570.125792452487, 14652.706945861022, 14729.484468043567, 4852.393450818648, 5034.572061374824, 5198.662086964411, 5207.0366982108435, 5209.817656382084, 12264.448099835528, 12298.754024919452, 12312.569060082855, 12330.691732706755, 12349.382530873421, 5505.752241149158, 5533.170024496358, 5537.778488860481, 5552.194931734956, 5554.055810512223, 4746.477887432379, 4816.783244753994, 4887.511248875155, 4918.508149185053, 4959.776810043557, 3539.531094595714, 3716.2381711749026, 3735.589085200626, 3739.1586892949413, 3759.1166075972124, 1100.998091736516, 1101.1521128730833, 1109.7114750164853, 1112.8831472695413, 1126.0372381613765, 658.2594581096266, 669.2404121322335, 674.0798809624924, 693.1958927643909, 700.6811900585221, 4872.074305881871, 4901.828436004723, 4978.502149784992, 4996.7501624918605, 5097.388313402415, 550.4577990679178, 552.9087700529368, 553.8559974406684, 555.6249531566177, 557.3479029535372, 3134.655187929326, 3182.7612929030415, 3353.496975453653, 3387.796732196076, 3487.145649315883, 12098.213616114925, 12355.6911077222, 12599.18105323151, 12615.476904618929, 12709.491620335268, 12391.566295179626, 12588.370581471074, 12596.55912043074, 12633.747325053448, 12688.238705677504, 6962.199347075049, 7157.498975071695, 7227.385672217921, 7249.31131542492, 7308.0, 5449.12813949782, 5481.698506582176, 5488.670679759227, 5632.85917852057, 5743.655380677173, 10860.402677852479, 11082.16883733707, 11224.94387528057, 11327.093832493545, 11479.540818367172, 11664.241824281395, 11710.414479276173, 11857.288562686266, 11913.82129268079, 11925.807419258004, 7204.423646108194, 7221.205667376479, 7239.384652304613, 7275.381592564691, 7301.379382752313, 8975.820483590422, 9342.112499312554, 9370.34407591462, 9384.483853387856, 9399.10708482693, 7360.631968401452, 7389.556626602421, 7512.5492470451945, 7542.132654744555, 7678.884816727642, 7540.17058123595, 7607.885881711668, 7617.047869016373, 7660.846783064196, 7679.19368466303, 6611.239707433707, 6645.401913827779, 6694.665266736741, 6738.180691213247, 6745.831354215988, 4905.754712264301, 4976.129177394014, 5032.974835125801, 5071.188609822559, 5243.292155558951, 4718.551737584924, 5010.348654674869, 5247.4490178530705, 5313.601479889101, 5350.250964864844], "value": 4536.02102416812, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [376.74004936593747, 392.8467897519967, 398.63524874739613, 400.96591789697874, 401.0155069304857, 5408.702521361323, 5546.584006199531, 5562.610617256789, 5612.747426365808, 5620.269364982551, 5284.920726189111, 5353.7590808413615, 5374.113271310229, 5385.730713464321, 5415.0, 4132.739514448092, 4132.834686612532, 4137.524184718758, 4140.130572579762, 4143.585641435862, 4003.819828107742, 4123.484564429446, 4140.461739973799, 4150.08698086422, 4154.023804405962, 4077.816498257571, 4084.14233011068, 4094.7338423002557, 4097.528784189826, 4114.403411505345, 4083.8979025524304, 4095.2219078375015, 4102.958970410287, 4118.567550407209, 4126.502112697174, 3605.242898991215, 3612.6929211017095, 3626.7642603230706, 3628.056705256652, 3629.9291708945925, 5211.765470553834, 5277.920831187535, 5278.947210527922, 5303.0, 5348.652337598043, 4801.68789028712, 4814.253790662453, 4828.299896515021, 4834.709917404932, 4839.830605928775, 5465.240053772819, 5724.8282551523525, 5749.022666146765, 5751.654900705971, 5776.59563830532, 3982.4026396040535, 3986.880393588197, 4011.6991225657903, 4018.4374187613757, 4036.0717035081802, 5931.525477961753, 6018.428249316308, 6022.434167116581, 6089.725962331706, 6090.330063693034, 4081.6122468365456, 4082.6937979651643, 4093.5087789465456, 4104.0, 4125.319322311845, 4147.958520414818, 4150.460440142762, 4165.416841642173, 4186.120914607905, 4188.225178342016, 4713.410823647044, 4779.235322348408, 4806.567408933143, 4824.831130910401, 4828.420589529279, 5745.6552606843725, 5765.654060756368, 5773.24947756789, 5775.364709881909, 5777.508911742465, 1425.1235490173676, 1440.7118576284786, 1443.4009885897444, 1450.2023886862185, 1450.9056911300731, 935.0696057422907, 957.7653474898694, 961.7643677299106, 967.5500892085214, 976.9853452198223, 4920.704757714549, 4940.987097644974, 4957.157283261854, 4979.278004689299, 5002.624803139779, 5934.1692163097205, 5951.404859514014, 5964.761409543569, 5968.582199246011, 5975.671338076448, 4783.95216047842, 4952.331435256267, 4970.030843985461, 4977.452480227172, 4979.726115063634, 3136.247300647828, 3183.0450864740487, 3184.26761844777, 3192.4413227685063, 3202.3115030268605, 5449.6730196188355, 5563.554915606742, 5570.108782594765, 5595.0, 5596.804111856147, 6086.2087928569, 6128.662923539248, 6132.080187971751, 6168.9691551542855, 6170.074488826712, 5543.25166102571, 5546.63946843462, 5554.6944918029085, 5583.302087239095, 5585.69278689676, 5913.34953155144, 5948.583599148018, 5984.730687119003, 5997.280326360865, 6006.969965150146, 5869.706514674163, 5906.346223057551, 5911.438413350725, 5940.643561386158, 5940.940590594038, 5402.378726446352, 5467.289252397163, 5505.018193450434, 5527.479943015542, 5539.7230138492105, 4072.572379900068, 4100.118474527991, 4114.732542384735, 4121.340585506305, 4124.793760311913, 5892.850894075614, 5991.310999235144, 6030.728617212324, 6038.365971572922, 6039.4262545058145, 5733.684647344436, 5757.481826635623, 5760.884782304414, 5768.192453056659, 5801.822687664874, 5751.223584816164, 5760.596758226884, 5792.478676919098, 5812.488752924186, 5818.592698511064, 5602.803901863415, 5655.066913959316, 5712.828615141552, 5721.971390143022, 5723.198752174782, 5826.155207494805, 5829.598653016945, 5835.623282538097, 5843.7370318336625, 5868.3251426086545, 5444.156155795858, 5506.889862202814, 5596.916046259391, 5671.206031155724, 5674.404187560247], "value": 4314.974019493257, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [713.0872483221478, 733.1349008170357, 755.0222461911824, 755.3277582951173, 778.3889646627397, 10874.238803283773, 11773.529058837657, 12791.104622676405, 13587.18476891386, 13691.178529288238, 14305.284735763196, 14451.132932024086, 14883.553493395215, 14935.477258295934, 15021.098734075964, 821.6631181215718, 831.4969443486694, 831.9417640765149, 833.6498670558381, 835.8620827563475, 894.6645008121955, 899.0245583541865, 902.2781774580342, 904.3669431398015, 905.483874191711, 929.8605209218604, 930.888293404789, 931.0131260863473, 932.9860052099224, 934.4626839567276, 918.5040078357679, 920.9125133112343, 922.524899676667, 922.6540047482194, 934.1825902335456, 679.120538902118, 679.2019377231733, 681.0839420978775, 683.9452843772486, 691.2258270736756, 12154.5745898894, 12415.0, 12508.49966001359, 13557.932210338886, 13624.727505449835, 14620.488282910153, 14673.192974386404, 14704.705905881823, 15022.399104035825, 15060.0, 11654.125940554492, 11782.764344713143, 11788.764224715458, 11854.644360669108, 12269.141160118796, 2863.3700585871075, 2869.913902582926, 2870.7703383729254, 2881.2652773542613, 2883.8269703817627, 59245.0, 59825.0, 59923.101153482734, 60695.0, 61390.386096138915, 11915.40422978865, 11989.160758746979, 12357.443915023845, 12359.022556390933, 12383.071269654813, 21324.14703411877, 21548.892255538623, 21904.12383504642, 21949.341519754435, 22004.33986980361, 5679.2333035040565, 5823.2429784128635, 5824.767009319665, 5846.064629659234, 5890.4993075589055, 2814.352698879269, 2825.632667753179, 2828.3212029112865, 2841.8294902305515, 2858.285428642839, 3275.7870738401925, 3325.584301962255, 3334.733221342287, 3359.3449277391164, 3454.516367708523, 717.7810767715897, 721.231888039247, 721.4516967105038, 728.0898876404494, 729.5002922997763, 555.9471850174227, 588.2088590845307, 588.8204097750141, 592.0881841963414, 603.6860832367145, 9021.864672029924, 9103.681371151977, 9456.8581471278, 9636.277279204087, 9946.353487023465, 546.7484956919782, 554.7060058169177, 561.4638020690231, 564.4271064869162, 582.0367292131529, 4058.7564746115327, 4207.768572728468, 4214.557471465513, 4316.201502722007, 4316.6546676265825, 59513.053212329345, 59952.0, 60157.699211504536, 60313.39686603078, 61921.38078619156, 54306.18540721892, 54465.0, 54741.0, 55167.448325517034, 56425.71787141038, 48514.75742621264, 48728.02543949101, 49265.50734492609, 49357.25964110541, 50770.74614626977, 8568.443051201652, 8586.939134607774, 8677.652893884175, 8717.171868672465, 8768.78078048054, 25274.74725252724, 25303.74696253014, 25538.233852984442, 25723.614145787455, 26623.600645990715, 30540.0, 30654.693453066076, 30749.385012300078, 31175.0, 31212.375752484368, 10400.58397664085, 10530.0, 10573.841392378967, 10598.099161571352, 10636.149108071491, 14302.141871487744, 14349.139051656517, 14847.40610375573, 15055.0, 15237.23813809283, 13347.199168049949, 13623.931880340535, 13839.169649821042, 13879.79180312276, 14135.858641413453, 12719.173253738478, 13075.673108172372, 13139.14595551286, 13209.537666181637, 13354.065215434826, 12112.515499379926, 12137.0, 12234.75530489403, 12696.936515317364, 12909.35453227316, 8941.105889411007, 8967.461952282623, 9165.908340916505, 9284.860727089233, 9685.079917407835, 10276.691699249035, 10333.793324133625, 10385.844212336971, 11006.174536909924, 11281.71795705114], "value": 6435.061358664852, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1551.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 115.0, 114.0, 114.0, 114.0, 111.0, 112.0, 112.0, 112.0, 114.0], "value": 112.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 123.0, 130.0, 169.0, 125.0, 125.0, 125.0, 126.0, 147.0, 123.0], "value": 135.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 166.0, 164.0, 162.0, 166.0, 169.0, 167.0, 164.0, 166.0], "value": 164.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 75.0, 103.0, 76.0, 75.0, 75.0, 75.0, 95.0, 77.0], "value": 80.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 104.0, 89.0, 84.0, 82.0, 101.0, 83.0, 84.0, 108.0], "value": 90.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 115.0, 114.0, 118.0, 114.0, 113.0, 114.0, 114.0, 119.0, 117.0], "value": 115.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 151.0, 151.0, 151.0, 152.0, 152.0, 151.0, 152.0, 150.0, 151.0], "value": 151.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 99.0, 95.0, 99.0, 95.0, 95.0, 95.0, 95.0, 95.0], "value": 95.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 56.0, 58.0, 55.0, 56.0, 58.0, 56.0, 55.0, 55.0, 56.0], "value": 55.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 58.0, 58.0, 59.0, 58.0, 57.0, 58.0, 61.0, 57.0, 57.0], "value": 58.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 82.0, 83.0, 82.0, 82.0, 82.0, 83.0, 83.0, 83.0, 88.0], "value": 83.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 143.0, 138.0, 132.0, 133.0, 135.0, 137.0, 133.0, 190.0, 134.0], "value": 141.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [195.0, 184.0, 195.0, 207.0, 202.0, 184.0, 204.0, 183.0, 189.0, 191.0], "value": 193.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 73.0, 76.0, 75.0, 75.0, 73.0, 75.0, 77.0, 72.0, 72.0], "value": 75.0, "unit": "score"}]}]} 13:42:12 INFO - Return code: 0 13:42:12 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:42:12 INFO - # TBPL SUCCESS # 13:42:12 INFO - Running post-action listener: _resource_record_post_action 13:42:12 INFO - [mozharness: 2017-05-22 20:42:12.500394Z] Finished run-tests step (success) 13:42:12 INFO - Running post-run listener: _resource_record_post_run 13:42:12 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 8192; Write bytes: 407896064; Read time: 192; Write time: 222196 13:42:12 INFO - TinderboxPrint: CPU usage
13.3% 13:42:12 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 192 13:42:12 INFO - TinderboxPrint: I/O write bytes / time
407,896,064 / 222,196 13:42:12 INFO - TinderboxPrint: CPU idle
8,292.2 (86.7%) 13:42:12 INFO - TinderboxPrint: CPU user
1,218.9 (12.7%) 13:42:12 INFO - TinderboxPrint: Swap in / out
0 / 0 13:42:12 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 30744576; Read time: 0; Write time: 5916 13:42:12 INFO - run-tests - Wall time: 1183s; CPU: 13.0%; Read bytes: 8192; Write bytes: 325910528; Read time: 192; Write time: 195264 13:42:13 INFO - Running post-run listener: _upload_blobber_files 13:42:13 INFO - Blob upload gear active. 13:42:13 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:42:13 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 13:42:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 13:42:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 13:42:13 INFO - (blobuploader) - INFO - Open directory for files ... 13:42:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 13:42:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:42:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:42:14 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 13:42:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:42:14 INFO - (blobuploader) - INFO - Done attempting. 13:42:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:42:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:42:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:42:17 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:42:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:42:17 INFO - (blobuploader) - INFO - Done attempting. 13:42:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:42:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:42:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:42:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:42:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:42:18 INFO - (blobuploader) - INFO - Done attempting. 13:42:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:42:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:42:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:42:19 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:42:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:42:19 INFO - (blobuploader) - INFO - Done attempting. 13:42:19 INFO - (blobuploader) - INFO - Iteration through files over. 13:42:19 INFO - Return code: 0 13:42:19 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:42:19 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:42:19 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7b39b198ca007e5938361ed74de0aa1dba1914823ddbaf7f6e2abfce54047ae98736f6ec518e4ab31aca20cae9a4035f77c9447261ecc502f7d83ef860ce8063", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/03832bb2b720fa3dfb3da8e1dd511affaaf24da4eb5b31ae692200853f0e3484eec61d53949d477b910048c252723b178bf4ab67b019b26e7d46a7c3ba055c2b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54a7ec2a6570162290aa1801c76505d728406c6ddcc19ebc8814da72e263fdb27b0eebefa7405a7a8d1a1b17e51af1193132e26366d9105a8204af04a39bf949", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5200f27b81662a6f6431d36ce661efacb77ee27671912160eb71fb16ea96a81b64d0ff392275c8cfb3f23585131ac0002f99efe82760b3b217ccadbaea1265c3"} 13:42:19 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:42:19 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:42:19 INFO - Contents: 13:42:19 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7b39b198ca007e5938361ed74de0aa1dba1914823ddbaf7f6e2abfce54047ae98736f6ec518e4ab31aca20cae9a4035f77c9447261ecc502f7d83ef860ce8063", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/03832bb2b720fa3dfb3da8e1dd511affaaf24da4eb5b31ae692200853f0e3484eec61d53949d477b910048c252723b178bf4ab67b019b26e7d46a7c3ba055c2b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54a7ec2a6570162290aa1801c76505d728406c6ddcc19ebc8814da72e263fdb27b0eebefa7405a7a8d1a1b17e51af1193132e26366d9105a8204af04a39bf949", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5200f27b81662a6f6431d36ce661efacb77ee27671912160eb71fb16ea96a81b64d0ff392275c8cfb3f23585131ac0002f99efe82760b3b217ccadbaea1265c3"} 13:42:19 INFO - Running post-run listener: copy_logs_to_upload_dir 13:42:19 INFO - Copying logs to upload dir... 13:42:19 INFO - mkdir: /builds/slave/test/build/upload/logs 13:42:19 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1254.081869 ========= master_lag: 0.33 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 54 secs) (at 2017-05-22 13:42:18.465155) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-22 13:42:18.472382) ========= 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=9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7b39b198ca007e5938361ed74de0aa1dba1914823ddbaf7f6e2abfce54047ae98736f6ec518e4ab31aca20cae9a4035f77c9447261ecc502f7d83ef860ce8063", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/03832bb2b720fa3dfb3da8e1dd511affaaf24da4eb5b31ae692200853f0e3484eec61d53949d477b910048c252723b178bf4ab67b019b26e7d46a7c3ba055c2b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54a7ec2a6570162290aa1801c76505d728406c6ddcc19ebc8814da72e263fdb27b0eebefa7405a7a8d1a1b17e51af1193132e26366d9105a8204af04a39bf949", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5200f27b81662a6f6431d36ce661efacb77ee27671912160eb71fb16ea96a81b64d0ff392275c8cfb3f23585131ac0002f99efe82760b3b217ccadbaea1265c3"} build_url:https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011334 build_url: 'https://queue.taskcluster.net/v1/task/FQ-rYfRyStmdGmVUBE59ZA/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7b39b198ca007e5938361ed74de0aa1dba1914823ddbaf7f6e2abfce54047ae98736f6ec518e4ab31aca20cae9a4035f77c9447261ecc502f7d83ef860ce8063", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/03832bb2b720fa3dfb3da8e1dd511affaaf24da4eb5b31ae692200853f0e3484eec61d53949d477b910048c252723b178bf4ab67b019b26e7d46a7c3ba055c2b", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54a7ec2a6570162290aa1801c76505d728406c6ddcc19ebc8814da72e263fdb27b0eebefa7405a7a8d1a1b17e51af1193132e26366d9105a8204af04a39bf949", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5200f27b81662a6f6431d36ce661efacb77ee27671912160eb71fb16ea96a81b64d0ff392275c8cfb3f23585131ac0002f99efe82760b3b217ccadbaea1265c3"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-22 13:42:18.499405) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:42:18.499724) ========= 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=9bfb7e13875ed353a705960e000001c0-1495484483.599897-1840590029 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004527 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 13:42:18.581723) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-22 13:42:18.583339) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-22 13:42:18.583687) ========= ========= Total master_lag: 0.48 =========